[INFO] fetching crate debug_tree 0.4.0...
[INFO] testing debug_tree-0.4.0 against try#ecabaf78506b7a4668d42dc20268c086b93f0fad for pr-87041
[INFO] extracting crate debug_tree 0.4.0 into /workspace/builds/worker-12/source
[INFO] validating manifest of crates.io crate debug_tree 0.4.0 on toolchain ecabaf78506b7a4668d42dc20268c086b93f0fad
[INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+ecabaf78506b7a4668d42dc20268c086b93f0fad" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }`
[INFO] started tweaking crates.io crate debug_tree 0.4.0
[INFO] finished tweaking crates.io crate debug_tree 0.4.0
[INFO] tweaked toml for crates.io crate debug_tree 0.4.0 written to /workspace/builds/worker-12/source/Cargo.toml
[INFO] crate crates.io crate debug_tree 0.4.0 already has a lockfile, it will not be regenerated
[INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+ecabaf78506b7a4668d42dc20268c086b93f0fad" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] [stderr]  Downloading crates ...
[INFO] [stderr]   Downloaded tokio v0.2.13
[INFO] [stderr]   Downloaded proc-macro-hack v0.5.12
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-12/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-12/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:34b6a614d2c27851fe6cbf88fbd1137609cefab8b10d0615aaeb6fd47975d74e" "/opt/rustwide/cargo-home/bin/cargo" "+ecabaf78506b7a4668d42dc20268c086b93f0fad" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }`
[INFO] [stdout] 08658c695b2b162f400b63859abec06183205a6917c6a8c588d821fa882ccc66
[INFO] running `Command { std: "docker" "start" "-a" "08658c695b2b162f400b63859abec06183205a6917c6a8c588d821fa882ccc66", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "08658c695b2b162f400b63859abec06183205a6917c6a8c588d821fa882ccc66", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "08658c695b2b162f400b63859abec06183205a6917c6a8c588d821fa882ccc66", kill_on_drop: false }`
[INFO] [stdout] 08658c695b2b162f400b63859abec06183205a6917c6a8c588d821fa882ccc66
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-12/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-12/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:34b6a614d2c27851fe6cbf88fbd1137609cefab8b10d0615aaeb6fd47975d74e" "/opt/rustwide/cargo-home/bin/cargo" "+ecabaf78506b7a4668d42dc20268c086b93f0fad" "build" "--frozen" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] 492794d1bd77501dd4a843ba1bbb58e8bf908373e352bc4ac5f45695bb39afce
[INFO] running `Command { std: "docker" "start" "-a" "492794d1bd77501dd4a843ba1bbb58e8bf908373e352bc4ac5f45695bb39afce", kill_on_drop: false }`
[INFO] [stderr]    Compiling once_cell v1.3.1
[INFO] [stderr]    Compiling debug_tree v0.4.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 0.98s
[INFO] running `Command { std: "docker" "inspect" "492794d1bd77501dd4a843ba1bbb58e8bf908373e352bc4ac5f45695bb39afce", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "492794d1bd77501dd4a843ba1bbb58e8bf908373e352bc4ac5f45695bb39afce", kill_on_drop: false }`
[INFO] [stdout] 492794d1bd77501dd4a843ba1bbb58e8bf908373e352bc4ac5f45695bb39afce
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-12/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-12/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:34b6a614d2c27851fe6cbf88fbd1137609cefab8b10d0615aaeb6fd47975d74e" "/opt/rustwide/cargo-home/bin/cargo" "+ecabaf78506b7a4668d42dc20268c086b93f0fad" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] 310aafe38cf4985e00c4780295b89e09bd09b564addd3c68e0538a936e377b76
[INFO] running `Command { std: "docker" "start" "-a" "310aafe38cf4985e00c4780295b89e09bd09b564addd3c68e0538a936e377b76", kill_on_drop: false }`
[INFO] [stderr]    Compiling proc-macro2 v1.0.9
[INFO] [stderr]    Compiling unicode-xid v0.2.0
[INFO] [stderr]    Compiling syn v1.0.16
[INFO] [stderr]    Compiling memchr v2.3.3
[INFO] [stderr]    Compiling proc-macro-nested v0.1.4
[INFO] [stderr]    Compiling futures-core v0.3.4
[INFO] [stderr]    Compiling futures-sink v0.3.4
[INFO] [stderr]    Compiling futures-io v0.3.4
[INFO] [stderr]    Compiling slab v0.4.2
[INFO] [stderr]    Compiling pin-utils v0.1.0-alpha.4
[INFO] [stderr]    Compiling futures-task v0.3.4
[INFO] [stderr]    Compiling pin-project-lite v0.1.4
[INFO] [stderr]    Compiling bytes v0.5.4
[INFO] [stderr]    Compiling futures-channel v0.3.4
[INFO] [stderr]    Compiling quote v1.0.3
[INFO] [stderr]    Compiling proc-macro-hack v0.5.12
[INFO] [stderr]    Compiling tokio-macros v0.2.5
[INFO] [stderr]    Compiling tokio v0.2.13
[INFO] [stderr]    Compiling futures-macro v0.3.4
[INFO] [stderr]    Compiling futures-util v0.3.4
[INFO] [stderr]    Compiling futures-executor v0.3.4
[INFO] [stderr]    Compiling futures v0.3.4
[INFO] [stderr]    Compiling debug_tree v0.4.0 (/opt/rustwide/workdir)
[INFO] [stdout] warning: unused imports: `max`, `min`
[INFO] [stdout]  --> src/test.rs:5:20
[INFO] [stdout]   |
[INFO] [stdout] 5 |     use std::cmp::{max, min};
[INFO] [stdout]   |                    ^^^  ^^^
[INFO] [stdout]   |
[INFO] [stdout]   = note: `#[warn(unused_imports)]` on by default
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] warning: 1 warning emitted
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stderr]     Finished test [unoptimized + debuginfo] target(s) in 13.94s
[INFO] running `Command { std: "docker" "inspect" "310aafe38cf4985e00c4780295b89e09bd09b564addd3c68e0538a936e377b76", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "310aafe38cf4985e00c4780295b89e09bd09b564addd3c68e0538a936e377b76", kill_on_drop: false }`
[INFO] [stdout] 310aafe38cf4985e00c4780295b89e09bd09b564addd3c68e0538a936e377b76
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-12/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-12/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:34b6a614d2c27851fe6cbf88fbd1137609cefab8b10d0615aaeb6fd47975d74e" "/opt/rustwide/cargo-home/bin/cargo" "+ecabaf78506b7a4668d42dc20268c086b93f0fad" "test" "--frozen", kill_on_drop: false }`
[INFO] [stdout] caded6d236266601fc8565f3cb8effe570e9cb4340dfdff3a338c4e6e4c8a2c3
[INFO] running `Command { std: "docker" "start" "-a" "caded6d236266601fc8565f3cb8effe570e9cb4340dfdff3a338c4e6e4c8a2c3", kill_on_drop: false }`
[INFO] [stderr] warning: unused imports: `max`, `min`
[INFO] [stderr]  --> src/test.rs:5:20
[INFO] [stderr]   |
[INFO] [stderr] 5 |     use std::cmp::{max, min};
[INFO] [stderr]   |                    ^^^  ^^^
[INFO] [stderr]   |
[INFO] [stderr]   = note: `#[warn(unused_imports)]` on by default
[INFO] [stderr] 
[INFO] [stderr] warning: 1 warning emitted
[INFO] [stderr] 
[INFO] [stderr]     Finished test [unoptimized + debuginfo] target(s) in 0.02s
[INFO] [stderr]      Running unittests (/opt/rustwide/target/debug/deps/debug_tree-c19d26a96a407c62)
[INFO] [stdout] 
[INFO] [stdout] running 28 tests
[INFO] [stdout] test default::test::leaf_with_value ... ok
[INFO] [stdout] test default::test::named_branch ... ok
[INFO] [stdout] test default::test::unnamed_branch ... ok
[INFO] [stdout] test test::test::depth ... ok
[INFO] [stdout] test test::test::disabled_output ... ok
[INFO] [stdout] test test::test::enabled_output ... ok
[INFO] [stdout] test test::test::async_barrier ... ok
[INFO] [stdout] test test::test::format_output ... ok
[INFO] [stdout] test test::test::format_output_dashed ... ok
[INFO] [stdout] test test::test::format_output_rounded ... ok
[INFO] [stdout] test test::test::format_output_pipes ... ok
[INFO] [stdout] test test::test::indent ... ok
[INFO] [stdout] test test::test::leaf_with_value ... ok
[INFO] [stdout] test test::test::macros2 ... ok
[INFO] [stdout] test test::test::macros_with_fn ... ok
[INFO] [stdout] test test::test::macros ... ok
[INFO] [stdout] test test::test::recursive ... ok
[INFO] [stdout] test test::test::simple ... ok
[INFO] [stdout] test test::test::format_output_thick ... ok
[INFO] [stdout] test test::test::mid ... ok
[INFO] [stdout] test test::test::test_branch2 ... ok
[INFO] [stdout] test test::test::test_branch ... ok
[INFO] [stdout] test test::test::tree_by_name ... ok
[INFO] [stdout] test test::test::nested ... ok
[INFO] [stdout] test test::test::tree_by_name_disabled ... ok
[INFO] [stdout] test test::test::defer_peek_write ... FAILED
[INFO] [stdout] test test::test::defer_peek_write_panic - should panic ... ok
[INFO] [stdout] test test::test::defer_write ... FAILED
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout] 
[INFO] [stdout] ---- test::test::defer_peek_write stdout ----
[INFO] [stdout] thread 'test::test::defer_peek_write' panicked at 'called `Result::unwrap()` on an `Err` value: Os { code: 2, kind: NotFound, message: "No such file or directory" }', src/test.rs:359:59
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x558687302980 - std::backtrace_rs::backtrace::libunwind::trace::h706b838f5bbd876b
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/../../backtrace/src/backtrace/libunwind.rs:90:5
[INFO] [stdout]    1:     0x558687302980 - std::backtrace_rs::backtrace::trace_unsynchronized::hc15f29ae7822b7b8
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/../../backtrace/src/backtrace/mod.rs:66:5
[INFO] [stdout]    2:     0x558687302980 - std::sys_common::backtrace::_print_fmt::h7c580c971f91926c
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:67:5
[INFO] [stdout]    3:     0x558687302980 - <std::sys_common::backtrace::_print::DisplayBacktrace as core::fmt::Display>::fmt::h2a772198c4032452
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:46:22
[INFO] [stdout]    4:     0x55868732564c - core::fmt::write::h9a6d9c74526a6c1b
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/fmt/mod.rs:1115:17
[INFO] [stdout]    5:     0x5586872ff7b5 - std::io::Write::write_fmt::h583dff5009d01a9f
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/io/mod.rs:1663:15
[INFO] [stdout]    6:     0x558687304b3b - std::sys_common::backtrace::_print::h5b3c171e6f864ae4
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:49:5
[INFO] [stdout]    7:     0x558687304b3b - std::sys_common::backtrace::print::h93b9e9ed2a98e611
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:36:9
[INFO] [stdout]    8:     0x558687304b3b - std::panicking::default_hook::{{closure}}::hd8da92bb68d520c5
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:208:50
[INFO] [stdout]    9:     0x55868730464c - std::panicking::default_hook::hdbc8b2951c5afbab
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:222:9
[INFO] [stdout]   10:     0x558687305204 - std::panicking::rust_panic_with_hook::h8a4c841655926f4e
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:622:17
[INFO] [stdout]   11:     0x558687304ce7 - std::panicking::begin_panic_handler::{{closure}}::h471b6bc74904b7b0
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:519:13
[INFO] [stdout]   12:     0x558687302e7c - std::sys_common::backtrace::__rust_end_short_backtrace::h309f5c707f29932f
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:141:18
[INFO] [stdout]   13:     0x558687304c49 - rust_begin_unwind
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:515:5
[INFO] [stdout]   14:     0x558687259641 - core::panicking::panic_fmt::hcf5f6d96e1dd7099
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/panicking.rs:92:14
[INFO] [stdout]   15:     0x558687259733 - core::result::unwrap_failed::he898b02f57993c42
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/result.rs:1355:5
[INFO] [stdout]   16:     0x558687280a1e - core::result::Result<T,E>::unwrap::h6c21509aaf1f883c
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/result.rs:1037:23
[INFO] [stdout]   17:     0x558687268afb - debug_tree::test::test::defer_peek_write::h78b0c8980152cfaf
[INFO] [stdout]                                at /opt/rustwide/workdir/src/test.rs:359:13
[INFO] [stdout]   18:     0x55868726899a - debug_tree::test::test::defer_peek_write::{{closure}}::h0140988d41ca57b3
[INFO] [stdout]                                at /opt/rustwide/workdir/src/test.rs:354:5
[INFO] [stdout]   19:     0x558687284b4e - core::ops::function::FnOnce::call_once::h3490dbc880bc9994
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:227:5
[INFO] [stdout]   20:     0x5586872d4dd3 - core::ops::function::FnOnce::call_once::h99a97b0ff983bd25
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:227:5
[INFO] [stdout]   21:     0x5586872d4dd3 - test::__rust_begin_short_backtrace::h8fe0d26ed1584e50
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/test/src/lib.rs:577:5
[INFO] [stdout]   22:     0x5586872d3860 - <alloc::boxed::Box<F,A> as core::ops::function::FnOnce<Args>>::call_once::he6b90e352f394d8f
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/alloc/src/boxed.rs:1572:9
[INFO] [stdout]   23:     0x5586872d3860 - <std::panic::AssertUnwindSafe<F> as core::ops::function::FnOnce<()>>::call_once::h1c05475e029700b8
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:347:9
[INFO] [stdout]   24:     0x5586872d3860 - std::panicking::try::do_call::he6de943476ae628a
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:401:40
[INFO] [stdout]   25:     0x5586872d3860 - std::panicking::try::ha21937b8feb06f89
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:365:19
[INFO] [stdout]   26:     0x5586872d3860 - std::panic::catch_unwind::ha79830b3325c9fa6
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:434:14
[INFO] [stdout]   27:     0x5586872d3860 - test::run_test_in_process::h1ab180b83ee2d5b5
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/test/src/lib.rs:600:18
[INFO] [stdout]   28:     0x5586872d3860 - test::run_test::run_test_inner::{{closure}}::h8258ffe088f187a1
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/test/src/lib.rs:492:39
[INFO] [stdout]   29:     0x5586872ace22 - test::run_test::run_test_inner::{{closure}}::hc697b214abd32bc6
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/test/src/lib.rs:519:37
[INFO] [stdout]   30:     0x5586872ace22 - std::sys_common::backtrace::__rust_begin_short_backtrace::h64de0d3f894854a9
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:125:18
[INFO] [stdout]   31:     0x5586872b0a78 - std::thread::Builder::spawn_unchecked::{{closure}}::{{closure}}::h1fd98fc86e533ece
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/thread/mod.rs:476:17
[INFO] [stdout]   32:     0x5586872b0a78 - <std::panic::AssertUnwindSafe<F> as core::ops::function::FnOnce<()>>::call_once::h4e2a7abf702e4cfd
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:347:9
[INFO] [stdout]   33:     0x5586872b0a78 - std::panicking::try::do_call::h4496392321a3c8c0
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:401:40
[INFO] [stdout]   34:     0x5586872b0a78 - std::panicking::try::hf1e14258e04e8e9a
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:365:19
[INFO] [stdout]   35:     0x5586872b0a78 - std::panic::catch_unwind::hb72c3777cd55642f
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:434:14
[INFO] [stdout]   36:     0x5586872b0a78 - std::thread::Builder::spawn_unchecked::{{closure}}::h2d7915a5910e148e
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/thread/mod.rs:475:30
[INFO] [stdout]   37:     0x5586872b0a78 - core::ops::function::FnOnce::call_once{{vtable.shim}}::h83fd2f1ef5be797c
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:227:5
[INFO] [stdout]   38:     0x55868730a237 - <alloc::boxed::Box<F,A> as core::ops::function::FnOnce<Args>>::call_once::ha8b1d5a0092467fc
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/alloc/src/boxed.rs:1572:9
[INFO] [stdout]   39:     0x55868730a237 - <alloc::boxed::Box<F,A> as core::ops::function::FnOnce<Args>>::call_once::h4b9f24ec4e8a879e
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/alloc/src/boxed.rs:1572:9
[INFO] [stdout]   40:     0x55868730a237 - std::sys::unix::thread::Thread::new::thread_start::h2a0e98fbc4ab4c32
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys/unix/thread.rs:72:17
[INFO] [stdout]   41:     0x7fb6dfaf8609 - start_thread
[INFO] [stdout]   42:     0x7fb6df8ca293 - clone
[INFO] [stdout]   43:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] ---- test::test::defer_write stdout ----
[INFO] [stdout] thread 'test::test::defer_write' panicked at 'called `Result::unwrap()` on an `Err` value: Os { code: 2, kind: NotFound, message: "No such file or directory" }', src/test.rs:340:54
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x558687302980 - std::backtrace_rs::backtrace::libunwind::trace::h706b838f5bbd876b
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/../../backtrace/src/backtrace/libunwind.rs:90:5
[INFO] [stdout]    1:     0x558687302980 - std::backtrace_rs::backtrace::trace_unsynchronized::hc15f29ae7822b7b8
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/../../backtrace/src/backtrace/mod.rs:66:5
[INFO] [stdout]    2:     0x558687302980 - std::sys_common::backtrace::_print_fmt::h7c580c971f91926c
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:67:5
[INFO] [stdout]    3:     0x558687302980 - <std::sys_common::backtrace::_print::DisplayBacktrace as core::fmt::Display>::fmt::h2a772198c4032452
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:46:22
[INFO] [stdout]    4:     0x55868732564c - core::fmt::write::h9a6d9c74526a6c1b
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/fmt/mod.rs:1115:17
[INFO] [stdout]    5:     0x5586872ff7b5 - std::io::Write::write_fmt::h583dff5009d01a9f
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/io/mod.rs:1663:15
[INFO] [stdout]    6:     0x558687304b3b - std::sys_common::backtrace::_print::h5b3c171e6f864ae4
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:49:5
[INFO] [stdout]    7:     0x558687304b3b - std::sys_common::backtrace::print::h93b9e9ed2a98e611
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:36:9
[INFO] [stdout]    8:     0x558687304b3b - std::panicking::default_hook::{{closure}}::hd8da92bb68d520c5
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:208:50
[INFO] [stdout]    9:     0x55868730464c - std::panicking::default_hook::hdbc8b2951c5afbab
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:222:9
[INFO] [stdout]   10:     0x558687305204 - std::panicking::rust_panic_with_hook::h8a4c841655926f4e
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:622:17
[INFO] [stdout]   11:     0x558687304ce7 - std::panicking::begin_panic_handler::{{closure}}::h471b6bc74904b7b0
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:519:13
[INFO] [stdout]   12:     0x558687302e7c - std::sys_common::backtrace::__rust_end_short_backtrace::h309f5c707f29932f
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:141:18
[INFO] [stdout]   13:     0x558687304c49 - rust_begin_unwind
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:515:5
[INFO] [stdout]   14:     0x558687259641 - core::panicking::panic_fmt::hcf5f6d96e1dd7099
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/panicking.rs:92:14
[INFO] [stdout]   15:     0x558687259733 - core::result::unwrap_failed::he898b02f57993c42
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/result.rs:1355:5
[INFO] [stdout]   16:     0x558687280a1e - core::result::Result<T,E>::unwrap::h6c21509aaf1f883c
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/result.rs:1037:23
[INFO] [stdout]   17:     0x5586872681cb - debug_tree::test::test::defer_write::hc94948af71f5a2e8
[INFO] [stdout]                                at /opt/rustwide/workdir/src/test.rs:340:13
[INFO] [stdout]   18:     0x55868726806a - debug_tree::test::test::defer_write::{{closure}}::ha740f5f79852cdce
[INFO] [stdout]                                at /opt/rustwide/workdir/src/test.rs:335:5
[INFO] [stdout]   19:     0x5586872851ae - core::ops::function::FnOnce::call_once::he280ab967f78239a
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:227:5
[INFO] [stdout]   20:     0x5586872d4dd3 - core::ops::function::FnOnce::call_once::h99a97b0ff983bd25
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:227:5
[INFO] [stdout]   21:     0x5586872d4dd3 - test::__rust_begin_short_backtrace::h8fe0d26ed1584e50
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/test/src/lib.rs:577:5
[INFO] [stdout]   22:     0x5586872d3860 - <alloc::boxed::Box<F,A> as core::ops::function::FnOnce<Args>>::call_once::he6b90e352f394d8f
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/alloc/src/boxed.rs:1572:9
[INFO] [stdout]   23:     0x5586872d3860 - <std::panic::AssertUnwindSafe<F> as core::ops::function::FnOnce<()>>::call_once::h1c05475e029700b8
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:347:9
[INFO] [stdout]   24:     0x5586872d3860 - std::panicking::try::do_call::he6de943476ae628a
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:401:40
[INFO] [stdout]   25:     0x5586872d3860 - std::panicking::try::ha21937b8feb06f89
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:365:19
[INFO] [stdout]   26:     0x5586872d3860 - std::panic::catch_unwind::ha79830b3325c9fa6
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:434:14
[INFO] [stdout]   27:     0x5586872d3860 - test::run_test_in_process::h1ab180b83ee2d5b5
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/test/src/lib.rs:600:18
[INFO] [stdout]   28:     0x5586872d3860 - test::run_test::run_test_inner::{{closure}}::h8258ffe088f187a1
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/test/src/lib.rs:492:39
[INFO] [stdout]   29:     0x5586872ace22 - test::run_test::run_test_inner::{{closure}}::hc697b214abd32bc6
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/test/src/lib.rs:519:37
[INFO] [stdout]   30:     0x5586872ace22 - std::sys_common::backtrace::__rust_begin_short_backtrace::h64de0d3f894854a9
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys_common/backtrace.rs:125:18
[INFO] [stdout]   31:     0x5586872b0a78 - std::thread::Builder::spawn_unchecked::{{closure}}::{{closure}}::h1fd98fc86e533ece
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/thread/mod.rs:476:17
[INFO] [stdout]   32:     0x5586872b0a78 - <std::panic::AssertUnwindSafe<F> as core::ops::function::FnOnce<()>>::call_once::h4e2a7abf702e4cfd
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:347:9
[INFO] [stdout]   33:     0x5586872b0a78 - std::panicking::try::do_call::h4496392321a3c8c0
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:401:40
[INFO] [stdout]   34:     0x5586872b0a78 - std::panicking::try::hf1e14258e04e8e9a
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panicking.rs:365:19
[INFO] [stdout]   35:     0x5586872b0a78 - std::panic::catch_unwind::hb72c3777cd55642f
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/panic.rs:434:14
[INFO] [stdout]   36:     0x5586872b0a78 - std::thread::Builder::spawn_unchecked::{{closure}}::h2d7915a5910e148e
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/thread/mod.rs:475:30
[INFO] [stdout]   37:     0x5586872b0a78 - core::ops::function::FnOnce::call_once{{vtable.shim}}::h83fd2f1ef5be797c
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/core/src/ops/function.rs:227:5
[INFO] [stdout]   38:     0x55868730a237 - <alloc::boxed::Box<F,A> as core::ops::function::FnOnce<Args>>::call_once::ha8b1d5a0092467fc
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/alloc/src/boxed.rs:1572:9
[INFO] [stdout]   39:     0x55868730a237 - <alloc::boxed::Box<F,A> as core::ops::function::FnOnce<Args>>::call_once::h4b9f24ec4e8a879e
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/alloc/src/boxed.rs:1572:9
[INFO] [stdout]   40:     0x55868730a237 - std::sys::unix::thread::Thread::new::thread_start::h2a0e98fbc4ab4c32
[INFO] [stdout]                                at /rustc/ecabaf78506b7a4668d42dc20268c086b93f0fad/library/std/src/sys/unix/thread.rs:72:17
[INFO] [stdout]   41:     0x7fb6dfaf8609 - start_thread
[INFO] [stdout]   42:     0x7fb6df8ca293 - clone
[INFO] [stdout]   43:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout]     test::test::defer_peek_write
[INFO] [stdout]     test::test::defer_write
[INFO] [stdout] 
[INFO] [stdout] test result: FAILED. 26 passed; 2 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.01s
[INFO] [stdout] 
[INFO] [stderr] error: test failed, to rerun pass '--lib'
[INFO] running `Command { std: "docker" "inspect" "caded6d236266601fc8565f3cb8effe570e9cb4340dfdff3a338c4e6e4c8a2c3", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "caded6d236266601fc8565f3cb8effe570e9cb4340dfdff3a338c4e6e4c8a2c3", kill_on_drop: false }`
[INFO] [stdout] caded6d236266601fc8565f3cb8effe570e9cb4340dfdff3a338c4e6e4c8a2c3