01H7EZ4CSH1C0PDDM7VT2JF0Y4: test-ds

BasicConfig {
    output_rules: [
        "/tmp/*.txt",
    ],
    rust_toolchain: None,
    target: Some(
        "helios-2.0",
    ),
    access_repos: [],
    publish: [],
    skip_clone: true,
}

Buildomat Job: 01H7EZ4NSKXKNF19DCDE8VNY25

Tags:

Output:

SEQ GLOBAL TIME DETAILS
12023-08-10T05:59:03.679Zjob dependencies complete; ready to run (waiting for 22 m 29 s)
22023-08-10T05:59:57.790Zjob assigned to worker 01H7F0E3V31FTW9WZCWYAAHJ0K (queued for 54 s)
32023-08-10T05:59:58.071Zdownloading input: /input/build/work/bins/crucible-downstairs.gz
42023-08-10T06:00:03.286Zdownloaded input: /input/build/work/bins/crucible-downstairs.gz
52023-08-10T06:00:03.289Zdownloading input: /input/build/work/bins/crucible-hammer.gz
62023-08-10T06:00:05.485Zdownloaded input: /input/build/work/bins/crucible-hammer.gz
72023-08-10T06:00:05.488Zdownloading input: /input/build/work/bins/crutest.gz
82023-08-10T06:00:17.067Zdownloaded input: /input/build/work/bins/crutest.gz
92023-08-10T06:00:17.070Zdownloading input: /input/build/work/bins/dsc.gz
102023-08-10T06:00:26.424Zdownloaded input: /input/build/work/bins/dsc.gz
112023-08-10T06:00:26.428Zdownloading input: /input/build/work/scripts/test_ds.sh
122023-08-10T06:00:26.495Zdownloaded input: /input/build/work/scripts/test_ds.sh
132023-08-10T06:00:26.500Zdownloading input: /input/build/work/scripts/test_live_repair.sh
142023-08-10T06:00:26.561Zdownloaded input: /input/build/work/scripts/test_live_repair.sh
152023-08-10T06:00:26.574Zdownloading input: /input/build/work/scripts/test_repair.sh
162023-08-10T06:00:26.626Zdownloaded input: /input/build/work/scripts/test_repair.sh
172023-08-10T06:00:26.653Zdownloading input: /input/build/work/scripts/test_up.sh
182023-08-10T06:00:26.758Zdownloaded input: /input/build/work/scripts/test_up.sh
192023-08-10T06:00:26.762Zdownloading input: /input/build/tmp/cargo-test-out.log
202023-08-10T06:00:30.880Zdownloaded input: /input/build/tmp/cargo-test-out.log
 
212023-08-10T06:00:30.924Zstarting task 0: "setup"
222023-08-10T06:00:31.005Z++ uname -s
232023-08-10T06:00:31.010Z+ kern=SunOS
242023-08-10T06:00:31.015Z+ case "$kern" in
252023-08-10T06:00:31.021Z+ groupadd -g 12345 build
262023-08-10T06:00:31.027Z+ useradd -u 12345 -g build -d /home/build -s /bin/bash -c build -P 'Primary Administrator' build
272023-08-10T06:00:33.027Z+ zfs create -o mountpoint=/work rpool/work
282023-08-10T06:00:33.198Z++ awk '$2 == "/home" { print $3 }' /etc/mnttab
292023-08-10T06:00:33.223Z+ home_fs=zfs
302023-08-10T06:00:33.240Z+ [[ zfs == autofs ]]
312023-08-10T06:00:33.255Z+ mkdir -p /home/build
322023-08-10T06:00:33.270Z+ chown build:build /home/build /work
332023-08-10T06:00:35.620Z+ chmod 0700 /home/build /work
342023-08-10T06:00:35.632Zprocess exited: duration 4262 ms, exit code 0
 
352023-08-10T06:00:35.676Zstarting task 1: "authentication"
362023-08-10T06:00:35.733Zprocess exited: duration 39 ms, exit code 0
 
372023-08-10T06:00:36.185Zstarting task 2: "build"
382023-08-10T06:00:36.205Z+ echo 'input bins dir contains:'
392023-08-10T06:00:36.226Zinput bins dir contains:
402023-08-10T06:00:37.485Z+ ls -ltr /input/build/work/bins
412023-08-10T06:00:37.916Ztotal 673744
422023-08-10T06:00:37.940Z-rw-r--r-- 1 root root 108899860 Aug 10 06:00 crucible-downstairs.gz
432023-08-10T06:00:37.968Z-rw-r--r-- 1 root root 69594543 Aug 10 06:00 crucible-hammer.gz
442023-08-10T06:00:38.397Z-rw-r--r-- 1 root root 97531181 Aug 10 06:00 crutest.gz
452023-08-10T06:00:38.409Z-rw-r--r-- 1 root root 68703972 Aug 10 06:00 dsc.gz
462023-08-10T06:00:38.445Z+ banner unpack
472023-08-10T06:00:38.459Z
482023-08-10T06:00:38.474Z # # # # ##### ## #### # #
492023-08-10T06:00:38.494Z # # ## # # # # # # # # #
502023-08-10T06:00:38.528Z # # # # # # # # # # ####
512023-08-10T06:00:38.971Z # # # # # ##### ###### # # #
522023-08-10T06:00:38.986Z # # # ## # # # # # # #
532023-08-10T06:00:39.000Z #### # # # # # #### # #
542023-08-10T06:00:39.012Z
552023-08-10T06:00:39.024Z+ mkdir -p /var/tmp/bins
562023-08-10T06:00:39.039Z+ for t in "$input/bins/"*.gz
572023-08-10T06:00:39.477Z++ basename /input/build/work/bins/crucible-downstairs.gz
582023-08-10T06:00:39.494Z+ b=crucible-downstairs.gz
592023-08-10T06:00:39.510Z+ b=crucible-downstairs
602023-08-10T06:00:39.523Z+ gunzip
612023-08-10T06:00:40.488Z+ chmod +x /var/tmp/bins/crucible-downstairs
622023-08-10T06:00:40.495Z+ for t in "$input/bins/"*.gz
632023-08-10T06:00:40.504Z++ basename /input/build/work/bins/crucible-hammer.gz
642023-08-10T06:00:40.508Z+ b=crucible-hammer.gz
652023-08-10T06:00:40.514Z+ b=crucible-hammer
662023-08-10T06:00:40.518Z+ gunzip
672023-08-10T06:00:42.477Z+ chmod +x /var/tmp/bins/crucible-hammer
682023-08-10T06:00:42.491Z+ for t in "$input/bins/"*.gz
692023-08-10T06:00:42.507Z++ basename /input/build/work/bins/crutest.gz
702023-08-10T06:00:42.524Z+ b=crutest.gz
712023-08-10T06:00:42.570Z+ b=crutest
722023-08-10T06:00:42.599Z+ gunzip
732023-08-10T06:00:45.795Z+ chmod +x /var/tmp/bins/crutest
742023-08-10T06:00:45.798Z+ for t in "$input/bins/"*.gz
752023-08-10T06:00:45.801Z++ basename /input/build/work/bins/dsc.gz
762023-08-10T06:00:45.804Z+ b=dsc.gz
772023-08-10T06:00:45.807Z+ b=dsc
782023-08-10T06:00:45.810Z+ gunzip
792023-08-10T06:00:48.175Z+ chmod +x /var/tmp/bins/dsc
802023-08-10T06:00:48.181Z+ export BINDIR=/var/tmp/bins
812023-08-10T06:00:48.187Z+ BINDIR=/var/tmp/bins
822023-08-10T06:00:48.193Z+ banner test_ds
832023-08-10T06:00:48.201Z
842023-08-10T06:00:48.207Z ##### ###### #### ##### ##### ####
852023-08-10T06:00:48.216Z # # # # # # #
862023-08-10T06:00:48.226Z # ##### #### # # # ####
872023-08-10T06:00:48.251Z # # # # # # #
882023-08-10T06:00:48.270Z # # # # # # # # #
892023-08-10T06:00:48.686Z # ###### #### # ####### ##### ####
902023-08-10T06:00:48.692Z
912023-08-10T06:00:48.698Z+ ptime -m bash /input/build/work/scripts/test_ds.sh
922023-08-10T06:00:48.702Z/input/build/work
932023-08-10T06:00:48.706ZCreate file for import
942023-08-10T06:00:48.711Z300+0 records in
952023-08-10T06:00:48.716Z300+0 records out
962023-08-10T06:00:48.723Z153600 bytes (150 KiB) transferred in 0.006508 secs (23 MiB/sec)
972023-08-10T06:00:48.734ZImport region
982023-08-10T06:00:48.751Z{"msg":"current number of open files limit 16384 is already the maximum","v":0,"name":"crucible","level":30,"time":"2023-08-10T06:00:47.97136735Z","hostname":"ip-10-150-1-55.us-west-2.compute.internal","pid":1149}
992023-08-10T06:00:48.772Z{"msg":"Created new region file \"/tmp/ds_test/export/region.json\"","v":0,"name":"crucible","level":30,"time":"2023-08-10T06:00:47.974881068Z","hostname":"ip-10-150-1-55.us-west-2.compute.internal","pid":1149}
1002023-08-10T06:00:49.203ZImport file_size: 153600 Extent size: 51200 Needed extents: 3
1012023-08-10T06:00:50.025ZRegion already large enough for image
1022023-08-10T06:00:50.032ZImporting "/tmp/ds_test/import" to region
1032023-08-10T06:00:50.037ZPopulated 3 extents by copying 153600 bytes (300 blocks)
1042023-08-10T06:00:50.047Z{"msg":"UUID: 12345678-1234-1234-1234-000000000001","v":0,"name":"crucible","level":30,"time":"2023-08-10T06:00:48.04760111Z","hostname":"ip-10-150-1-55.us-west-2.compute.internal","pid":1149}
1052023-08-10T06:00:50.053Z{"msg":"Blocks per extent:100 Total Extents: 15","v":0,"name":"crucible","level":30,"time":"2023-08-10T06:00:48.047706155Z","hostname":"ip-10-150-1-55.us-west-2.compute.internal","pid":1149}
1062023-08-10T06:00:50.062ZExport region
1072023-08-10T06:00:50.069Z{"msg":"current number of open files limit 16384 is already the maximum","v":0,"name":"crucible","level":30,"time":"2023-08-10T06:00:48.085017786Z","hostname":"ip-10-150-1-55.us-west-2.compute.internal","pid":1150}
1082023-08-10T06:00:50.075Z{"msg":"Opened existing region file \"/tmp/ds_test/export/region.json\"","v":0,"name":"crucible","level":30,"time":"2023-08-10T06:00:48.085460779Z","hostname":"ip-10-150-1-55.us-west-2.compute.internal","pid":1150}
1092023-08-10T06:00:50.086Z{"msg":"Database read version 1","v":0,"name":"crucible","level":30,"time":"2023-08-10T06:00:48.08551792Z","hostname":"ip-10-150-1-55.us-west-2.compute.internal","pid":1150}
1102023-08-10T06:00:50.095Z{"msg":"Database write version 1","v":0,"name":"crucible","level":30,"time":"2023-08-10T06:00:48.085569246Z","hostname":"ip-10-150-1-55.us-west-2.compute.internal","pid":1150}
1112023-08-10T06:00:50.107ZExport total_size: 768000 Extent size:51200 Total Extents:15
1122023-08-10T06:00:50.118ZExporting from start_block: 0 count:300
1132023-08-10T06:00:50.130ZRead and wrote out 300 blocks
1142023-08-10T06:00:50.141ZImport Export test passed
1152023-08-10T06:00:50.153Z
1162023-08-10T06:00:50.162Zreal 0.624293986
1172023-08-10T06:00:50.177Zuser 0.084838434
1182023-08-10T06:00:50.616Zsys 0.208531058
1192023-08-10T06:00:51.053Ztrap 0.000086493
1202023-08-10T06:00:51.064Ztflt 0.014200711
1212023-08-10T06:00:51.079Zdflt 0.119628715
1222023-08-10T06:00:51.094Zkflt 0.001631690
1232023-08-10T06:00:51.134Zlock 1.040188268
1242023-08-10T06:00:51.595Zslp 0.957244144
1252023-08-10T06:00:51.613Zlat 0.009343709
1262023-08-10T06:00:51.631Zstop 0.001426178
1272023-08-10T06:00:51.652Zprocess exited: duration 12623 ms, exit code 0
 
1282023-08-10T06:00:51.670Zfound 0 output files