Nov 02 03:30:43.472 INFO testing structopt-flags-0.1.0 against beta-2018-10-30 for beta-1.31-1
Nov 02 03:30:43.472 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/beta-1.31-1/worker-2/beta-2018-10-30:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-2/beta-1.31-1/beta-2018-10-30:/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 +beta-2018-10-30 build --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Nov 02 03:30:44.003 INFO blam! 40a20db099d95689362a50ec30f11dc7b038fd4c2280f1116c8565460188a344
Nov 02 03:30:44.007 INFO running `"docker" "start" "-a" "40a20db099d95689362a50ec30f11dc7b038fd4c2280f1116c8565460188a344"`
Nov 02 03:30:45.008 INFO kablam! usermod: no changes
Nov 02 03:30:45.179 INFO kablam!    Compiling serde v1.0.80
Nov 02 03:30:56.571 INFO kablam!    Compiling serde_json v1.0.32
Nov 02 03:30:56.572 INFO kablam!    Compiling semver v0.9.0
Nov 02 03:31:02.469 INFO kablam!    Compiling cargo_metadata v0.5.8
Nov 02 03:31:05.984 INFO kablam!    Compiling skeptic v0.13.3
Nov 02 03:31:09.632 INFO kablam!    Compiling structopt-flags v0.1.0 (/source)
Nov 02 03:31:14.725 INFO kablam!     Finished dev [unoptimized + debuginfo] target(s) in 29.70s
Nov 02 03:31:14.733 INFO kablam! su: No module specific data is present
Nov 02 03:31:15.807 INFO running `"docker" "rm" "-f" "40a20db099d95689362a50ec30f11dc7b038fd4c2280f1116c8565460188a344"`
Nov 02 03:31:16.083 INFO blam! 40a20db099d95689362a50ec30f11dc7b038fd4c2280f1116c8565460188a344
Nov 02 03:31:16.087 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/beta-1.31-1/worker-2/beta-2018-10-30:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-2/beta-1.31-1/beta-2018-10-30:/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 +beta-2018-10-30 test --frozen --no-run" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Nov 02 03:31:16.467 INFO blam! 8c016069e2b04ee8670114479ac2ad59e0107aa667529bbf099872731a5678a7
Nov 02 03:31:16.467 INFO running `"docker" "start" "-a" "8c016069e2b04ee8670114479ac2ad59e0107aa667529bbf099872731a5678a7"`
Nov 02 03:31:17.796 INFO kablam! usermod: no changes
Nov 02 03:31:17.963 INFO kablam!    Compiling float-cmp v0.4.0
Nov 02 03:31:17.988 INFO kablam!    Compiling escargot v0.2.0
Nov 02 03:31:19.275 INFO kablam!    Compiling predicates v0.5.2
Nov 02 03:31:22.255 INFO kablam!    Compiling assert_cmd v0.4.0
Nov 02 03:31:26.165 INFO kablam!    Compiling structopt-flags v0.1.0 (/source)
Nov 02 03:31:30.879 INFO kablam! warning: unused `#[macro_use]` import
Nov 02 03:31:30.879 INFO kablam!  --> examples/verbose.rs:3:1
Nov 02 03:31:30.879 INFO kablam!   |
Nov 02 03:31:30.879 INFO kablam! 3 | #[macro_use]
Nov 02 03:31:30.879 INFO kablam!   | ^^^^^^^^^^^^
Nov 02 03:31:30.879 INFO kablam!   |
Nov 02 03:31:30.879 INFO kablam!   = note: #[warn(unused_imports)] on by default
Nov 02 03:31:30.879 INFO kablam! 
Nov 02 03:31:31.535 INFO kablam! warning: unused `#[macro_use]` import
Nov 02 03:31:31.535 INFO kablam!  --> examples/simple_verbose.rs:3:1
Nov 02 03:31:31.535 INFO kablam!   |
Nov 02 03:31:31.535 INFO kablam! 3 | #[macro_use]
Nov 02 03:31:31.535 INFO kablam!   | ^^^^^^^^^^^^
Nov 02 03:31:31.535 INFO kablam!   |
Nov 02 03:31:31.535 INFO kablam!   = note: #[warn(unused_imports)] on by default
Nov 02 03:31:31.535 INFO kablam! 
Nov 02 03:31:31.543 INFO kablam! warning: unused `#[macro_use]` import
Nov 02 03:31:31.543 INFO kablam!  --> examples/quiet_verbose.rs:3:1
Nov 02 03:31:31.543 INFO kablam!   |
Nov 02 03:31:31.543 INFO kablam! 3 | #[macro_use]
Nov 02 03:31:31.543 INFO kablam!   | ^^^^^^^^^^^^
Nov 02 03:31:31.563 INFO kablam!   |
Nov 02 03:31:31.563 INFO kablam!   = note: #[warn(unused_imports)] on by default
Nov 02 03:31:31.563 INFO kablam! 
Nov 02 03:31:36.430 INFO kablam!     Finished dev [unoptimized + debuginfo] target(s) in 18.60s
Nov 02 03:31:36.444 INFO kablam! su: No module specific data is present
Nov 02 03:31:37.084 INFO running `"docker" "rm" "-f" "8c016069e2b04ee8670114479ac2ad59e0107aa667529bbf099872731a5678a7"`
Nov 02 03:31:37.424 INFO blam! 8c016069e2b04ee8670114479ac2ad59e0107aa667529bbf099872731a5678a7
Nov 02 03:31:37.426 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/beta-1.31-1/worker-2/beta-2018-10-30:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-2/beta-1.31-1/beta-2018-10-30:/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 +beta-2018-10-30 test --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Nov 02 03:31:37.947 INFO blam! 8f409802032425563570e8f47d4c7600d6e394b3bf0bf1ffe27967875fa234f2
Nov 02 03:31:37.950 INFO running `"docker" "start" "-a" "8f409802032425563570e8f47d4c7600d6e394b3bf0bf1ffe27967875fa234f2"`
Nov 02 03:31:39.622 INFO kablam! usermod: no changes
Nov 02 03:31:39.807 INFO kablam!     Finished dev [unoptimized + debuginfo] target(s) in 0.16s
Nov 02 03:31:39.833 INFO kablam!      Running /target/debug/deps/structopt_flags-00af642cb3a477a1
Nov 02 03:31:39.846 INFO blam! 
Nov 02 03:31:39.846 INFO blam! running 0 tests
Nov 02 03:31:39.846 INFO blam! 
Nov 02 03:31:39.846 INFO blam! test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Nov 02 03:31:39.846 INFO blam! 
Nov 02 03:31:39.846 INFO kablam!      Running /target/debug/deps/skeptic-ec816a90d127c14a
Nov 02 03:31:39.860 INFO blam! 
Nov 02 03:31:39.860 INFO blam! running 1 test
Nov 02 03:32:39.861 INFO blam! test readme_sect_geting_started_line_20 ... test readme_sect_geting_started_line_20 has been running for over 60 seconds
Nov 02 03:32:54.109 INFO kablam! error[E0432]: unresolved import `failure::Error`
Nov 02 03:32:54.109 INFO kablam!  --> /tmp/rust-skeptic.KzC5nRbyYAGo/test.rs:7:5
Nov 02 03:32:54.109 INFO kablam!   |
Nov 02 03:32:54.109 INFO kablam! 7 | use failure::Error;
Nov 02 03:32:54.109 INFO kablam!   |     ^^^^^^^^^^^^^^ no `Error` in the root
Nov 02 03:32:54.109 INFO kablam! 
Nov 02 03:32:54.109 INFO kablam! warning: unused `#[macro_use]` import
Nov 02 03:32:54.109 INFO kablam!  --> /tmp/rust-skeptic.KzC5nRbyYAGo/test.rs:4:1
Nov 02 03:32:54.109 INFO kablam!   |
Nov 02 03:32:54.109 INFO kablam! 4 | #[macro_use]
Nov 02 03:32:54.109 INFO kablam!   | ^^^^^^^^^^^^
Nov 02 03:32:54.109 INFO kablam!   |
Nov 02 03:32:54.109 INFO kablam!   = note: #[warn(unused_imports)] on by default
Nov 02 03:32:54.109 INFO kablam! 
Nov 02 03:32:54.109 INFO kablam! error: aborting due to previous error
Nov 02 03:32:54.109 INFO kablam! 
Nov 02 03:32:54.109 INFO kablam! For more information about this error, try `rustc --explain E0432`.
Nov 02 03:32:54.138 INFO blam! test readme_sect_geting_started_line_20 ... FAILED
Nov 02 03:32:54.138 INFO blam! 
Nov 02 03:32:54.138 INFO blam! failures:
Nov 02 03:32:54.139 INFO blam! 
Nov 02 03:32:54.139 INFO blam! ---- readme_sect_geting_started_line_20 stdout ----
Nov 02 03:32:54.139 INFO blam! thread 'readme_sect_geting_started_line_20' panicked at 'Command failed:
Nov 02 03:32:54.139 INFO blam! "rustc" "/tmp/rust-skeptic.KzC5nRbyYAGo/test.rs" "--verbose" "--crate-type=bin" "-L" "/target/debug" "-L" "/target/debug/deps" "--target" "x86_64-unknown-linux-gnu" "--extern" "skeptic=/target/debug/deps/libskeptic-73165bd1829549d3.rlib" "--extern" "structopt_flags=/target/debug/deps/libstructopt_flags-c6dd1f3d7d3f2069.rlib" "--extern" "failure=/target/debug/deps/libfailure-b2c8f9a98540c702.rlib" "--extern" "log=/target/debug/deps/liblog-a0b83ff9b9a4d6fc.rlib" "--extern" "structopt=/target/debug/deps/libstructopt-3a7a07bef21d418d.rlib" "--extern" "assert_cmd=/target/debug/deps/libassert_cmd-bd60877cfd435a76.rlib" "-o" "/tmp/rust-skeptic.KzC5nRbyYAGo/out.exe"', /cargo-home/registry/src/github.com-1ecc6299db9ec823/skeptic-0.13.3/lib.rs:835:13
Nov 02 03:32:54.139 INFO blam! stack backtrace:
Nov 02 03:32:54.139 INFO blam!    0:     0x564726e4b00f - std::sys::unix::backtrace::tracing::imp::unwind_backtrace::h3c55afa80a996a32
Nov 02 03:32:54.139 INFO blam!                                at libstd/sys/unix/backtrace/tracing/gcc_s.rs:49
Nov 02 03:32:54.139 INFO blam!    1:     0x564726e57cd7 - std::sys_common::backtrace::print::hcef907ea7a07cd40
Nov 02 03:32:54.139 INFO blam!                                at libstd/sys_common/backtrace.rs:71
Nov 02 03:32:54.139 INFO blam!                                at libstd/sys_common/backtrace.rs:59
Nov 02 03:32:54.139 INFO blam!    2:     0x564726e507bf - std::panicking::default_hook::{{closure}}::hf541876c65f36ea7
Nov 02 03:32:54.139 INFO blam!                                at libstd/panicking.rs:211
Nov 02 03:32:54.139 INFO blam!    3:     0x564726e504be - std::panicking::default_hook::h4ecc06b30ae4459d
Nov 02 03:32:54.139 INFO blam!                                at libstd/panicking.rs:221
Nov 02 03:32:54.139 INFO blam!    4:     0x564726e50e9e - std::panicking::rust_panic_with_hook::h0cc6d9cc9f34a947
Nov 02 03:32:54.139 INFO blam!                                at libstd/panicking.rs:476
Nov 02 03:32:54.139 INFO blam!    5:     0x564726e50a41 - std::panicking::continue_panic_fmt::hc71ad5f01496e320
Nov 02 03:32:54.139 INFO blam!                                at libstd/panicking.rs:390
Nov 02 03:32:54.139 INFO blam!    6:     0x564726e5098e - std::panicking::begin_panic_fmt::hdb958223ae20ca60
Nov 02 03:32:54.139 INFO blam!                                at libstd/panicking.rs:345
Nov 02 03:32:54.139 INFO blam!    7:     0x564726cfa25c - skeptic::rt::interpret_output::h47d82faa40a8f436
Nov 02 03:32:54.139 INFO blam!                                at /cargo-home/registry/src/github.com-1ecc6299db9ec823/skeptic-0.13.3/lib.rs:835
Nov 02 03:32:54.139 INFO blam!    8:     0x564726cf997e - skeptic::rt::compile_test_case::h2c1531e2aa664f16
Nov 02 03:32:54.139 INFO blam!                                at /cargo-home/registry/src/github.com-1ecc6299db9ec823/skeptic-0.13.3/lib.rs:813
Nov 02 03:32:54.139 INFO blam!    9:     0x564726cf8e37 - skeptic::rt::run_test::h2a673858763319af
Nov 02 03:32:54.139 INFO blam!                                at /cargo-home/registry/src/github.com-1ecc6299db9ec823/skeptic-0.13.3/lib.rs:737
Nov 02 03:32:54.139 INFO blam!   10:     0x564726cb023a - skeptic::readme_sect_geting_started_line_20::h66a56ff3ef1abe3e
Nov 02 03:32:54.139 INFO blam!                                at /target/debug/build/structopt-flags-0dfefce75b37e008/out/skeptic-tests.rs:27
Nov 02 03:32:54.139 INFO blam!   11:     0x564726cb00f9 - skeptic::readme_sect_geting_started_line_20::{{closure}}::h611c07dad3071af0
Nov 02 03:32:54.139 INFO blam!                                at /target/debug/build/structopt-flags-0dfefce75b37e008/out/skeptic-tests.rs:2
Nov 02 03:32:54.139 INFO blam!   12:     0x564726caff4d - core::ops::function::FnOnce::call_once::h4a26a93f905ef256
Nov 02 03:32:54.139 INFO blam!                                at libcore/ops/function.rs:238
Nov 02 03:32:54.139 INFO blam!   13:     0x564726cb222e - <F as alloc::boxed::FnBox<A>>::call_box::hf32558bd83684b60
Nov 02 03:32:54.139 INFO blam!                                at libtest/lib.rs:1468
Nov 02 03:32:54.139 INFO blam!                                at libcore/ops/function.rs:238
Nov 02 03:32:54.139 INFO blam!                                at liballoc/boxed.rs:672
Nov 02 03:32:54.139 INFO blam!   14:     0x564726e62f09 - __rust_maybe_catch_panic
Nov 02 03:32:54.139 INFO blam!                                at libpanic_unwind/lib.rs:102
Nov 02 03:32:54.139 INFO blam!   15:     0x564726cd3e92 - std::sys_common::backtrace::__rust_begin_short_backtrace::h1bb71a7386fd3269
Nov 02 03:32:54.139 INFO blam!                                at libstd/panicking.rs:289
Nov 02 03:32:54.139 INFO blam!                                at libstd/panic.rs:392
Nov 02 03:32:54.139 INFO blam!                                at libtest/lib.rs:1423
Nov 02 03:32:54.139 INFO blam!                                at libstd/sys_common/backtrace.rs:136
Nov 02 03:32:54.139 INFO blam!   16:     0x564726cd4944 - std::panicking::try::do_call::h9b94719c3074bb5c
Nov 02 03:32:54.139 INFO blam!                                at libstd/thread/mod.rs:409
Nov 02 03:32:54.139 INFO blam!                                at libstd/panic.rs:313
Nov 02 03:32:54.139 INFO blam!                                at libstd/panicking.rs:310
Nov 02 03:32:54.139 INFO blam!   17:     0x564726e62f09 - __rust_maybe_catch_panic
Nov 02 03:32:54.139 INFO blam!                                at libpanic_unwind/lib.rs:102
Nov 02 03:32:54.139 INFO blam!   18:     0x564726cc1b6c - <F as alloc::boxed::FnBox<A>>::call_box::hb3bcd66d16fd3e84
Nov 02 03:32:54.139 INFO blam!                                at libstd/panicking.rs:289
Nov 02 03:32:54.139 INFO blam!                                at libstd/panic.rs:392
Nov 02 03:32:54.139 INFO blam!                                at libstd/thread/mod.rs:408
Nov 02 03:32:54.139 INFO blam!                                at liballoc/boxed.rs:672
Nov 02 03:32:54.139 INFO blam!   19:     0x564726e4d71d - std::sys_common::thread::start_thread::had0c80d121669d29
Nov 02 03:32:54.139 INFO blam!                                at liballoc/boxed.rs:682
Nov 02 03:32:54.139 INFO blam!                                at libstd/sys_common/thread.rs:24
Nov 02 03:32:54.139 INFO blam!   20:     0x564726e3f545 - std::sys::unix::thread::Thread::new::thread_start::h4a5b66a70d76f47f
Nov 02 03:32:54.139 INFO blam!                                at libstd/sys/unix/thread.rs:90
Nov 02 03:32:54.139 INFO blam!   21:     0x7f266df576b9 - start_thread
Nov 02 03:32:54.139 INFO blam!   22:     0x7f266da7741c - clone
Nov 02 03:32:54.139 INFO blam!   23:                0x0 - <unknown>
Nov 02 03:32:54.139 INFO blam! 
Nov 02 03:32:54.139 INFO blam! 
Nov 02 03:32:54.139 INFO blam! failures:
Nov 02 03:32:54.139 INFO blam!     readme_sect_geting_started_line_20
Nov 02 03:32:54.139 INFO blam! 
Nov 02 03:32:54.139 INFO blam! test result: FAILED. 0 passed; 1 failed; 0 ignored; 0 measured; 0 filtered out
Nov 02 03:32:54.139 INFO blam! 
Nov 02 03:32:54.142 INFO kablam! error: test failed, to rerun pass '--test skeptic'
Nov 02 03:32:54.145 INFO kablam! su: No module specific data is present
Nov 02 03:32:54.471 INFO running `"docker" "rm" "-f" "8f409802032425563570e8f47d4c7600d6e394b3bf0bf1ffe27967875fa234f2"`
Nov 02 03:32:54.609 INFO blam! 8f409802032425563570e8f47d4c7600d6e394b3bf0bf1ffe27967875fa234f2
