Dec 15 17:26:23.584 INFO testing dataloader-0.5.1 against master#bd47d6825bf4090517549d33cfef10d3300b4a75 for pr-56550
Dec 15 17:26:23.585 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56550/worker-6/master#bd47d6825bf4090517549d33cfef10d3300b4a75:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-6/pr-56550/master#bd47d6825bf4090517549d33cfef10d3300b4a75:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +bd47d6825bf4090517549d33cfef10d3300b4a75-alt build --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Dec 15 17:26:24.016 INFO [stdout] e8eb5aa6adb5d1c363a420c706f9213984ac351aa78f91a64ea503bfc23db0bd
Dec 15 17:26:24.020 INFO running `"docker" "start" "-a" "e8eb5aa6adb5d1c363a420c706f9213984ac351aa78f91a64ea503bfc23db0bd"`
Dec 15 17:26:26.059 INFO [stderr] usermod: no changes
Dec 15 17:26:26.219 INFO [stderr]    Compiling dataloader v0.5.1 (/source)
Dec 15 17:26:30.395 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 4.31s
Dec 15 17:26:30.398 INFO [stderr] su: No module specific data is present
Dec 15 17:26:30.828 INFO running `"docker" "inspect" "e8eb5aa6adb5d1c363a420c706f9213984ac351aa78f91a64ea503bfc23db0bd"`
Dec 15 17:26:31.292 INFO running `"docker" "rm" "-f" "e8eb5aa6adb5d1c363a420c706f9213984ac351aa78f91a64ea503bfc23db0bd"`
Dec 15 17:26:31.688 INFO [stdout] e8eb5aa6adb5d1c363a420c706f9213984ac351aa78f91a64ea503bfc23db0bd
Dec 15 17:26:31.692 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56550/worker-6/master#bd47d6825bf4090517549d33cfef10d3300b4a75:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-6/pr-56550/master#bd47d6825bf4090517549d33cfef10d3300b4a75:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +bd47d6825bf4090517549d33cfef10d3300b4a75-alt test --frozen --no-run" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Dec 15 17:26:32.172 INFO [stdout] 137286a6f5b3e878279b6f131907a0562469e2103f4299a8fcb44d5fd7c5c762
Dec 15 17:26:32.174 INFO running `"docker" "start" "-a" "137286a6f5b3e878279b6f131907a0562469e2103f4299a8fcb44d5fd7c5c762"`
Dec 15 17:26:33.442 INFO [stderr] usermod: no changes
Dec 15 17:26:33.647 INFO [stderr]    Compiling dataloader v0.5.1 (/source)
Dec 15 17:26:50.188 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 16.70s
Dec 15 17:26:50.195 INFO [stderr] su: No module specific data is present
Dec 15 17:26:50.539 INFO running `"docker" "inspect" "137286a6f5b3e878279b6f131907a0562469e2103f4299a8fcb44d5fd7c5c762"`
Dec 15 17:26:50.699 INFO running `"docker" "rm" "-f" "137286a6f5b3e878279b6f131907a0562469e2103f4299a8fcb44d5fd7c5c762"`
Dec 15 17:26:50.814 INFO [stdout] 137286a6f5b3e878279b6f131907a0562469e2103f4299a8fcb44d5fd7c5c762
Dec 15 17:26:50.814 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56550/worker-6/master#bd47d6825bf4090517549d33cfef10d3300b4a75:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-6/pr-56550/master#bd47d6825bf4090517549d33cfef10d3300b4a75:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +bd47d6825bf4090517549d33cfef10d3300b4a75-alt test --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Dec 15 17:26:51.007 INFO [stdout] 56b68940e467bb3f61c0a7db46e4c36757c67090350659c57dfde71198b54c7b
Dec 15 17:26:51.009 INFO running `"docker" "start" "-a" "56b68940e467bb3f61c0a7db46e4c36757c67090350659c57dfde71198b54c7b"`
Dec 15 17:26:51.385 INFO [stderr] usermod: no changes
Dec 15 17:26:51.482 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 0.08s
Dec 15 17:26:51.503 INFO [stderr]      Running /target/debug/deps/dataloader-bc25752a15d20902
Dec 15 17:26:51.505 INFO [stdout] 
Dec 15 17:26:51.505 INFO [stdout] running 27 tests
Dec 15 17:26:51.507 INFO [stdout] test tests::cached_loader::assert_kinds ... ok
Dec 15 17:26:51.571 INFO [stdout] test tests::cached_loader::pass_to_thread ... ok
Dec 15 17:26:51.576 INFO [stdout] test tests::cached_loader::nested_load ... ok
Dec 15 17:26:51.576 INFO [stdout] test tests::cached_loader::test_batch_fn_error ... ok
Dec 15 17:26:51.577 INFO [stdout] test tests::cached_loader::nested_load_many ... ok
Dec 15 17:26:51.577 INFO [stdout] test tests::cached_loader::smoke ... ok
Dec 15 17:26:51.608 INFO [stdout] test tests::cached_loader::test_clear ... ok
Dec 15 17:26:51.608 INFO [stdout] test tests::cached_loader::test_clear_all ... ok
Dec 15 17:26:51.609 INFO [stdout] test tests::cached_loader::test_prime ... ok
Dec 15 17:26:51.609 INFO [stdout] test tests::cached_loader::test_custom_cache ... ok
Dec 15 17:26:51.610 INFO [stdout] test tests::cached_loader::test_result_val ... ok
Dec 15 17:26:51.613 INFO [stdout] test tests::non_cached_loader::assert_kinds ... ok
Dec 15 17:26:51.613 INFO [stdout] test tests::non_cached_loader::nested_load ... ok
Dec 15 17:26:51.615 INFO [stdout] test tests::non_cached_loader::pass_to_thread ... ok
Dec 15 17:26:51.640 INFO [stdout] test tests::non_cached_loader::nested_load_many ... ok
Dec 15 17:26:51.640 INFO [stdout] test tests::non_cached_loader::smoke ... ok
Dec 15 17:26:51.640 INFO [stdout] test tests::cached_loader::test_run_by_core ... ok
Dec 15 17:26:51.642 INFO [stdout] test tests::non_cached_loader::test_result_val ... ok
Dec 15 17:26:51.642 INFO [stdout] test tests::non_cached_loader::test_batch_fn_error ... ok
Dec 15 17:26:51.644 INFO [stdout] test tests::non_cached_loader::test_values_length ... ok
Dec 15 17:26:51.646 INFO [stdout] test tests::non_cached_loader::test_run_by_core ... ok
Dec 15 17:26:51.709 INFO [stdout] test tests::cached_loader::dispatch_partial_batch ... ok
Dec 15 17:26:51.710 INFO [stdout] test tests::cached_loader::drop_loader ... ok
Dec 15 17:26:51.815 INFO [stdout] test tests::non_cached_loader::dispatch_partial_batch ... ok
Dec 15 17:26:51.840 INFO [stdout] test tests::non_cached_loader::test_batch_call_seq ... ok
Dec 15 17:26:52.010 INFO [stdout] test tests::cached_loader::test_batch_call_seq ... ok
Dec 15 17:26:53.613 INFO [stdout] test tests::non_cached_loader::drop_loader ... ok
Dec 15 17:26:53.613 INFO [stderr]    Doc-tests dataloader
Dec 15 17:26:53.613 INFO [stdout] 
Dec 15 17:26:53.613 INFO [stdout] test result: ok. 27 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 15 17:26:53.614 INFO [stdout] 
Dec 15 17:27:01.130 INFO [stdout] 
Dec 15 17:27:01.130 INFO [stdout] running 0 tests
Dec 15 17:27:01.130 INFO [stdout] 
Dec 15 17:27:01.130 INFO [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 15 17:27:01.130 INFO [stdout] 
Dec 15 17:27:01.130 INFO [stderr] su: No module specific data is present
Dec 15 17:27:01.480 INFO running `"docker" "inspect" "56b68940e467bb3f61c0a7db46e4c36757c67090350659c57dfde71198b54c7b"`
Dec 15 17:27:01.564 INFO running `"docker" "rm" "-f" "56b68940e467bb3f61c0a7db46e4c36757c67090350659c57dfde71198b54c7b"`
Dec 15 17:27:01.709 INFO [stdout] 56b68940e467bb3f61c0a7db46e4c36757c67090350659c57dfde71198b54c7b