Dec 06 20:46:00.324 INFO testing tasque-0.1.4 against master#906deae0790bd18681b937fe9a141a3c26cf1855 for pr-56514
Dec 06 20:46:00.324 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56514/worker-5/master#906deae0790bd18681b937fe9a141a3c26cf1855:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-5/pr-56514/master#906deae0790bd18681b937fe9a141a3c26cf1855:/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 +906deae0790bd18681b937fe9a141a3c26cf1855-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 06 20:46:00.692 INFO [stdout] 2baeeb44b5902090eae0a8c9e6c63c6de71d2415f3817277ed3df9633d6fbe1c
Dec 06 20:46:00.698 INFO running `"docker" "start" "-a" "2baeeb44b5902090eae0a8c9e6c63c6de71d2415f3817277ed3df9633d6fbe1c"`
Dec 06 20:46:01.164 INFO [stderr] usermod: no changes
Dec 06 20:46:01.260 INFO [stderr]    Compiling procinfo v0.4.2
Dec 06 20:46:16.391 INFO [stderr]    Compiling prometrics v0.1.11
Dec 06 20:46:21.920 INFO [stderr]    Compiling tasque v0.1.4 (/source)
Dec 06 20:46:23.844 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 22.65s
Dec 06 20:46:23.854 INFO [stderr] su: No module specific data is present
Dec 06 20:46:24.224 INFO running `"docker" "inspect" "2baeeb44b5902090eae0a8c9e6c63c6de71d2415f3817277ed3df9633d6fbe1c"`
Dec 06 20:46:24.372 INFO running `"docker" "rm" "-f" "2baeeb44b5902090eae0a8c9e6c63c6de71d2415f3817277ed3df9633d6fbe1c"`
Dec 06 20:46:24.720 INFO [stdout] 2baeeb44b5902090eae0a8c9e6c63c6de71d2415f3817277ed3df9633d6fbe1c
Dec 06 20:46:24.722 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56514/worker-5/master#906deae0790bd18681b937fe9a141a3c26cf1855:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-5/pr-56514/master#906deae0790bd18681b937fe9a141a3c26cf1855:/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 +906deae0790bd18681b937fe9a141a3c26cf1855-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 06 20:46:25.103 INFO [stdout] 07c1c6fe5bc59b74810b132026f83803c09d89275b9b97819176265898ec6553
Dec 06 20:46:25.105 INFO running `"docker" "start" "-a" "07c1c6fe5bc59b74810b132026f83803c09d89275b9b97819176265898ec6553"`
Dec 06 20:46:25.842 INFO [stderr] usermod: no changes
Dec 06 20:46:25.907 INFO [stderr]    Compiling tasque v0.1.4 (/source)
Dec 06 20:46:28.970 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 3.11s
Dec 06 20:46:28.974 INFO [stderr] su: No module specific data is present
Dec 06 20:46:29.246 INFO running `"docker" "inspect" "07c1c6fe5bc59b74810b132026f83803c09d89275b9b97819176265898ec6553"`
Dec 06 20:46:29.354 INFO running `"docker" "rm" "-f" "07c1c6fe5bc59b74810b132026f83803c09d89275b9b97819176265898ec6553"`
Dec 06 20:46:29.516 INFO [stdout] 07c1c6fe5bc59b74810b132026f83803c09d89275b9b97819176265898ec6553
Dec 06 20:46:29.522 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56514/worker-5/master#906deae0790bd18681b937fe9a141a3c26cf1855:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-5/pr-56514/master#906deae0790bd18681b937fe9a141a3c26cf1855:/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 +906deae0790bd18681b937fe9a141a3c26cf1855-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 06 20:46:29.963 INFO [stdout] 7ddb84646f920c3cf9212d09885cd1da46f6be02620674f04d46f16d5c9a445c
Dec 06 20:46:29.965 INFO running `"docker" "start" "-a" "7ddb84646f920c3cf9212d09885cd1da46f6be02620674f04d46f16d5c9a445c"`
Dec 06 20:46:31.360 INFO [stderr] usermod: no changes
Dec 06 20:46:31.488 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 0.07s
Dec 06 20:46:31.494 INFO [stderr]      Running /target/debug/deps/tasque-e43abfd38eb05afa
Dec 06 20:46:31.500 INFO [stdout] 
Dec 06 20:46:31.500 INFO [stdout] running 3 tests
Dec 06 20:46:31.524 INFO [stderr] thread '<unnamed>' panicked at 'explicit panic', src/lib.rs:84:26
Dec 06 20:46:31.524 INFO [stderr] stack backtrace:
Dec 06 20:46:31.544 INFO [stderr]    0:     0x563411b64843 - std::sys::unix::backtrace::tracing::imp::unwind_backtrace::h3c2ada0a2db8c5e7
Dec 06 20:46:31.544 INFO [stdout] test tests::multiple_workers_works ... ok
Dec 06 20:46:31.563 INFO [stderr]                                at src/libstd/sys/unix/backtrace/tracing/gcc_s.rs:49
Dec 06 20:46:31.563 INFO [stderr]    1:     0x563411b5eef8 - std::sys_common::backtrace::_print::h95865c77318e98b7
Dec 06 20:46:31.563 INFO [stderr]                                at src/libstd/sys_common/backtrace.rs:71
Dec 06 20:46:31.563 INFO [stderr]    2:     0x563411b637b2 - std::panicking::default_hook::{{closure}}::hb3d1f299fcea42e5
Dec 06 20:46:31.563 INFO [stderr]                                at src/libstd/sys_common/backtrace.rs:59
Dec 06 20:46:31.563 INFO [stderr]                                at src/libstd/panicking.rs:211
Dec 06 20:46:31.563 INFO [stderr]    3:     0x563411b6351d - std::panicking::default_hook::h4eae6f26f73244c8
Dec 06 20:46:31.563 INFO [stderr]                                at src/libstd/panicking.rs:227
Dec 06 20:46:31.563 INFO [stderr]    4:     0x563411b63ec0 - std::panicking::rust_panic_with_hook::h368d37fd53b59464
Dec 06 20:46:31.563 INFO [stderr]                                at src/libstd/panicking.rs:491
Dec 06 20:46:31.563 INFO [stderr]    5:     0x563411b4ca77 - std::panicking::begin_panic::h9d31b981cfdde774
Dec 06 20:46:31.563 INFO [stderr]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/panicking.rs:425
Dec 06 20:46:31.563 INFO [stderr]    6:     0x563411acc05c - tasque::tests::worker_restart_works::{{closure}}::h2dd44abe351efc8f
Dec 06 20:46:31.563 INFO [stderr]                                at src/lib.rs:84
Dec 06 20:46:31.563 INFO [stderr]    7:     0x563411a92be8 - tasque::task::Task::new::{{closure}}::h0a06d3e01d2e3fb3
Dec 06 20:46:31.563 INFO [stderr]                                at src/task.rs:21
Dec 06 20:46:31.563 INFO [stderr]    8:     0x563411a92de8 - tasque::task::Task::execute::h153fbb02e077e623
Dec 06 20:46:31.563 INFO [stderr]                                at src/task.rs:31
Dec 06 20:46:31.563 INFO [stderr]    9:     0x563411ac8e9f - tasque::worker::Worker::run_once::{{closure}}::h437669f7cca96b17
Dec 06 20:46:31.563 INFO [stderr]                                at src/worker.rs:25
Dec 06 20:46:31.563 INFO [stderr]   10:     0x563411ac5c15 - prometrics::metrics::histogram::Histogram::time::hdea31107a0b093c5
Dec 06 20:46:31.563 INFO [stderr]                                at /cargo-home/registry/src/github.com-1ecc6299db9ec823/prometrics-0.1.11/src/metrics/histogram.rs:101
Dec 06 20:46:31.563 INFO [stderr]   11:     0x563411ac8d94 - tasque::worker::Worker::run_once::h8b4790d4baa8ab03
Dec 06 20:46:31.563 INFO [stderr]                                at src/worker.rs:25
Dec 06 20:46:31.563 INFO [stderr]   12:     0x563411ac8c22 - tasque::worker::Worker::start::{{closure}}::haf8eff28f294f72b
Dec 06 20:46:31.563 INFO [stderr]                                at src/worker.rs:17
Dec 06 20:46:31.563 INFO [stderr]   13:     0x563411a9c617 - std::sys_common::backtrace::__rust_begin_short_backtrace::h8f7145e054fa601f
Dec 06 20:46:31.563 INFO [stderr]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/sys_common/backtrace.rs:136
Dec 06 20:46:31.563 INFO [stderr]   14:     0x563411a8c144 - std::thread::Builder::spawn_unchecked::{{closure}}::{{closure}}::h4efcdc4bde97e954
Dec 06 20:46:31.563 INFO [stderr]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/thread/mod.rs:477
Dec 06 20:46:31.563 INFO [stderr]   15:     0x563411ac5a57 - <std::panic::AssertUnwindSafe<F> as core::ops::function::FnOnce<()>>::call_once::h8d50d7f8a7590fcb
Dec 06 20:46:31.563 INFO [stderr]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/panic.rs:319
Dec 06 20:46:31.563 INFO [stderr]   16:     0x563411ac6a7f - std::panicking::try::do_call::h3317ce5deebac557
Dec 06 20:46:31.563 INFO [stderr]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/panicking.rs:310
Dec 06 20:46:31.563 INFO [stderr]   17:     0x563411b72489 - __rust_maybe_catch_panic
Dec 06 20:46:31.564 INFO [stderr]                                at src/libpanic_unwind/lib.rs:102
Dec 06 20:46:31.564 INFO [stderr]   18:     0x563411ac697f - std::panicking::try::ha075a7eea4bb33f2
Dec 06 20:46:31.564 INFO [stderr]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/panicking.rs:289
Dec 06 20:46:31.564 INFO [stderr]   19:     0x563411ac67b7 - std::panic::catch_unwind::hbcdad6c3df77eed6
Dec 06 20:46:31.564 INFO [stderr]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/panic.rs:398
Dec 06 20:46:31.564 INFO [stderr]   20:     0x563411a8bf11 - std::thread::Builder::spawn_unchecked::{{closure}}::hfb72fd4657cf171f
Dec 06 20:46:31.564 INFO [stderr]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/thread/mod.rs:476
Dec 06 20:46:31.564 INFO [stderr]   21:     0x563411a90a1f - <F as alloc::boxed::FnBox<A>>::call_box::h81dee1c1c59023be
Dec 06 20:46:31.564 INFO [stderr]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/liballoc/boxed.rs:673
Dec 06 20:46:31.564 INFO [stderr]   22:     0x563411b6644d - std::sys::unix::thread::Thread::new::thread_start::hea5f7f9c570dc4cd
Dec 06 20:46:31.564 INFO [stderr]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/liballoc/boxed.rs:683
Dec 06 20:46:31.564 INFO [stderr]                                at src/libstd/sys_common/thread.rs:24
Dec 06 20:46:31.564 INFO [stderr]                                at src/libstd/sys/unix/thread.rs:90
Dec 06 20:46:31.564 INFO [stderr]   23:     0x7fabeb5896b9 - start_thread
Dec 06 20:46:31.564 INFO [stderr]   24:     0x7fabeb0a941c - clone
Dec 06 20:46:31.564 INFO [stderr]   25:                0x0 - <unknown>
Dec 06 20:46:31.576 INFO [stdout] test tests::worker_restart_works ... FAILED
Dec 06 20:46:31.584 INFO [stdout] test tests::single_worker_works ... ok
Dec 06 20:46:31.585 INFO [stdout] 
Dec 06 20:46:31.585 INFO [stdout] failures:
Dec 06 20:46:31.585 INFO [stdout] 
Dec 06 20:46:31.585 INFO [stdout] ---- tests::worker_restart_works stdout ----
Dec 06 20:46:31.585 INFO [stdout] thread 'tests::worker_restart_works' panicked at 'assertion failed: `(left == right)`
Dec 06 20:46:31.585 INFO [stdout]   left: `None`,
Dec 06 20:46:31.585 INFO [stdout]  right: `Some(0)`', src/lib.rs:87:9
Dec 06 20:46:31.585 INFO [stdout] stack backtrace:
Dec 06 20:46:31.585 INFO [stdout]    0:     0x563411b64843 - std::sys::unix::backtrace::tracing::imp::unwind_backtrace::h3c2ada0a2db8c5e7
Dec 06 20:46:31.585 INFO [stdout]                                at src/libstd/sys/unix/backtrace/tracing/gcc_s.rs:49
Dec 06 20:46:31.585 INFO [stdout]    1:     0x563411b5eef8 - std::sys_common::backtrace::_print::h95865c77318e98b7
Dec 06 20:46:31.585 INFO [stdout]                                at src/libstd/sys_common/backtrace.rs:71
Dec 06 20:46:31.585 INFO [stdout]    2:     0x563411b637b2 - std::panicking::default_hook::{{closure}}::hb3d1f299fcea42e5
Dec 06 20:46:31.585 INFO [stdout]                                at src/libstd/sys_common/backtrace.rs:59
Dec 06 20:46:31.585 INFO [stdout]                                at src/libstd/panicking.rs:211
Dec 06 20:46:31.585 INFO [stdout]    3:     0x563411b6349c - std::panicking::default_hook::h4eae6f26f73244c8
Dec 06 20:46:31.585 INFO [stdout]                                at src/libstd/panicking.rs:221
Dec 06 20:46:31.585 INFO [stdout]    4:     0x563411b63ec0 - std::panicking::rust_panic_with_hook::h368d37fd53b59464
Dec 06 20:46:31.585 INFO [stdout]                                at src/libstd/panicking.rs:491
Dec 06 20:46:31.585 INFO [stdout]    5:     0x563411b63a41 - std::panicking::continue_panic_fmt::h1599d634b3be4304
Dec 06 20:46:31.585 INFO [stdout]                                at src/libstd/panicking.rs:398
Dec 06 20:46:31.585 INFO [stdout]    6:     0x563411b6398e - std::panicking::begin_panic_fmt::h2c0a418aaab204b3
Dec 06 20:46:31.585 INFO [stdout]                                at src/libstd/panicking.rs:353
Dec 06 20:46:31.585 INFO [stdout]    7:     0x563411acbfa5 - tasque::tests::worker_restart_works::h3562a6e0a24e5a0c
Dec 06 20:46:31.585 INFO [stdout]                                at src/lib.rs:87
Dec 06 20:46:31.585 INFO [stdout]    8:     0x563411acbc49 - tasque::tests::worker_restart_works::{{closure}}::hda663741712b4f6c
Dec 06 20:46:31.585 INFO [stdout]                                at src/lib.rs:81
Dec 06 20:46:31.585 INFO [stdout]    9:     0x563411a8c7ad - core::ops::function::FnOnce::call_once::h6b1468a94e9f9544
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libcore/ops/function.rs:238
Dec 06 20:46:31.585 INFO [stdout]   10:     0x563411ad4b7e - <F as alloc::boxed::FnBox<A>>::call_box::h994167e0fc25f327
Dec 06 20:46:31.585 INFO [stdout]                                at src/libtest/lib.rs:1471
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libcore/ops/function.rs:238
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/liballoc/boxed.rs:673
Dec 06 20:46:31.585 INFO [stdout]   11:     0x563411b72489 - __rust_maybe_catch_panic
Dec 06 20:46:31.585 INFO [stdout]                                at src/libpanic_unwind/lib.rs:102
Dec 06 20:46:31.585 INFO [stdout]   12:     0x563411acca83 - std::sys_common::backtrace::__rust_begin_short_backtrace::h5d34cfb78512c8c3
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/panicking.rs:289
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/panic.rs:398
Dec 06 20:46:31.585 INFO [stdout]                                at src/libtest/lib.rs:1426
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/sys_common/backtrace.rs:136
Dec 06 20:46:31.585 INFO [stdout]   13:     0x563411acd9a4 - std::panicking::try::do_call::h7a86b6211ebb5e72
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/thread/mod.rs:477
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/panic.rs:319
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/panicking.rs:310
Dec 06 20:46:31.585 INFO [stdout]   14:     0x563411b72489 - __rust_maybe_catch_panic
Dec 06 20:46:31.585 INFO [stdout]                                at src/libpanic_unwind/lib.rs:102
Dec 06 20:46:31.585 INFO [stdout]   15:     0x563411ad4a5c - <F as alloc::boxed::FnBox<A>>::call_box::h877dbe22cb3997f4
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/panicking.rs:289
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/panic.rs:398
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/libstd/thread/mod.rs:476
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/liballoc/boxed.rs:673
Dec 06 20:46:31.585 INFO [stdout]   16:     0x563411b6644d - std::sys::unix::thread::Thread::new::thread_start::hea5f7f9c570dc4cd
Dec 06 20:46:31.585 INFO [stdout]                                at /rustc/906deae0790bd18681b937fe9a141a3c26cf1855/src/liballoc/boxed.rs:683
Dec 06 20:46:31.585 INFO [stdout]                                at src/libstd/sys_common/thread.rs:24
Dec 06 20:46:31.585 INFO [stdout]                                at src/libstd/sys/unix/thread.rs:90
Dec 06 20:46:31.585 INFO [stdout]   17:     0x7fabeb5896b9 - start_thread
Dec 06 20:46:31.585 INFO [stdout]   18:     0x7fabeb0a941c - clone
Dec 06 20:46:31.585 INFO [stdout]   19:                0x0 - <unknown>
Dec 06 20:46:31.585 INFO [stdout] 
Dec 06 20:46:31.585 INFO [stdout] 
Dec 06 20:46:31.585 INFO [stdout] failures:
Dec 06 20:46:31.585 INFO [stdout]     tests::worker_restart_works
Dec 06 20:46:31.585 INFO [stdout] 
Dec 06 20:46:31.585 INFO [stdout] test result: FAILED. 2 passed; 1 failed; 0 ignored; 0 measured; 0 filtered out
Dec 06 20:46:31.585 INFO [stdout] 
Dec 06 20:46:31.585 INFO [stderr] error: test failed, to rerun pass '--lib'
Dec 06 20:46:31.592 INFO [stderr] su: No module specific data is present
Dec 06 20:46:31.878 INFO running `"docker" "inspect" "7ddb84646f920c3cf9212d09885cd1da46f6be02620674f04d46f16d5c9a445c"`
Dec 06 20:46:31.958 INFO running `"docker" "rm" "-f" "7ddb84646f920c3cf9212d09885cd1da46f6be02620674f04d46f16d5c9a445c"`
Dec 06 20:46:32.039 INFO [stdout] 7ddb84646f920c3cf9212d09885cd1da46f6be02620674f04d46f16d5c9a445c