[INFO] fetching crate pausable_clock 1.0.1... [INFO] testing pausable_clock-1.0.1 against master#ff2c56344c764af598ad33027e9c7a48881808ef for pr-118825 [INFO] extracting crate pausable_clock 1.0.1 into /workspace/builds/worker-5-tc1/source [INFO] validating manifest of crates.io crate pausable_clock 1.0.1 on toolchain ff2c56344c764af598ad33027e9c7a48881808ef [INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+ff2c56344c764af598ad33027e9c7a48881808ef" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }` [INFO] started tweaking crates.io crate pausable_clock 1.0.1 [INFO] finished tweaking crates.io crate pausable_clock 1.0.1 [INFO] tweaked toml for crates.io crate pausable_clock 1.0.1 written to /workspace/builds/worker-5-tc1/source/Cargo.toml [INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+ff2c56344c764af598ad33027e9c7a48881808ef" "generate-lockfile" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] [stderr] Updating crates.io index [INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+ff2c56344c764af598ad33027e9c7a48881808ef" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] [stderr] Downloading crates ... [INFO] [stderr] Downloaded generator v0.7.5 [INFO] [stderr] Downloaded loom v0.5.6 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/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:2788e3201cd34a07e3172128adcd8b3090168a8e3bcc40d7c032b9dda1df7d1c" "/opt/rustwide/cargo-home/bin/cargo" "+ff2c56344c764af598ad33027e9c7a48881808ef" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }` [INFO] [stdout] 8e4cf5c7a883897ca385b5001863bd16738195bc3c8cc01638cf18ad9fa352d5 [INFO] running `Command { std: "docker" "start" "-a" "8e4cf5c7a883897ca385b5001863bd16738195bc3c8cc01638cf18ad9fa352d5", kill_on_drop: false }` [INFO] running `Command { std: "docker" "inspect" "8e4cf5c7a883897ca385b5001863bd16738195bc3c8cc01638cf18ad9fa352d5", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "8e4cf5c7a883897ca385b5001863bd16738195bc3c8cc01638cf18ad9fa352d5", kill_on_drop: false }` [INFO] [stdout] 8e4cf5c7a883897ca385b5001863bd16738195bc3c8cc01638cf18ad9fa352d5 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/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" "RUSTDOCFLAGS=--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:2788e3201cd34a07e3172128adcd8b3090168a8e3bcc40d7c032b9dda1df7d1c" "/opt/rustwide/cargo-home/bin/cargo" "+ff2c56344c764af598ad33027e9c7a48881808ef" "build" "--frozen" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 356660d2c69a193d258902a25fe53e11dffb07ec18689a5319dd98600d519e8d [INFO] running `Command { std: "docker" "start" "-a" "356660d2c69a193d258902a25fe53e11dffb07ec18689a5319dd98600d519e8d", kill_on_drop: false }` [INFO] [stderr] Compiling pausable_clock v1.0.1 (/opt/rustwide/workdir) [INFO] [stderr] Finished dev [unoptimized + debuginfo] target(s) in 0.17s [INFO] running `Command { std: "docker" "inspect" "356660d2c69a193d258902a25fe53e11dffb07ec18689a5319dd98600d519e8d", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "356660d2c69a193d258902a25fe53e11dffb07ec18689a5319dd98600d519e8d", kill_on_drop: false }` [INFO] [stdout] 356660d2c69a193d258902a25fe53e11dffb07ec18689a5319dd98600d519e8d [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/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" "RUSTDOCFLAGS=--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:2788e3201cd34a07e3172128adcd8b3090168a8e3bcc40d7c032b9dda1df7d1c" "/opt/rustwide/cargo-home/bin/cargo" "+ff2c56344c764af598ad33027e9c7a48881808ef" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 8726f715ab7783e79e41ffc16541d1ea66a06bd8a30fd998e8cdbbd3c5377580 [INFO] running `Command { std: "docker" "start" "-a" "8726f715ab7783e79e41ffc16541d1ea66a06bd8a30fd998e8cdbbd3c5377580", kill_on_drop: false }` [INFO] [stderr] Compiling memoffset v0.9.0 [INFO] [stderr] Compiling crossbeam-utils v0.8.17 [INFO] [stderr] Compiling serde v1.0.193 [INFO] [stderr] Compiling num-traits v0.2.17 [INFO] [stderr] Compiling libc v0.2.151 [INFO] [stderr] Compiling rayon-core v1.12.0 [INFO] [stderr] Compiling serde_json v1.0.108 [INFO] [stderr] Compiling unicode-width v0.1.11 [INFO] [stderr] Compiling memchr v2.6.4 [INFO] [stderr] Compiling regex-syntax v0.8.2 [INFO] [stderr] Compiling plotters-backend v0.3.5 [INFO] [stderr] Compiling cast v0.3.0 [INFO] [stderr] Compiling same-file v1.0.6 [INFO] [stderr] Compiling half v1.8.2 [INFO] [stderr] Compiling oorandom v11.1.3 [INFO] [stderr] Compiling syn v2.0.41 [INFO] [stderr] Compiling textwrap v0.11.0 [INFO] [stderr] Compiling walkdir v2.4.0 [INFO] [stderr] Compiling criterion-plot v0.4.5 [INFO] [stderr] Compiling plotters-svg v0.3.5 [INFO] [stderr] Compiling clap v2.34.0 [INFO] [stderr] Compiling csv-core v0.1.11 [INFO] [stderr] Compiling crossbeam-epoch v0.9.16 [INFO] [stderr] Compiling atty v0.2.14 [INFO] [stderr] Compiling crossbeam-deque v0.8.4 [INFO] [stderr] Compiling plotters v0.3.5 [INFO] [stderr] Compiling regex-automata v0.4.3 [INFO] [stderr] Compiling rayon v1.8.0 [INFO] [stderr] Compiling regex v1.10.2 [INFO] [stderr] Compiling csv v1.3.0 [INFO] [stderr] Compiling serde_cbor v0.11.2 [INFO] [stderr] Compiling tinytemplate v1.2.1 [INFO] [stderr] Compiling serde_derive v1.0.193 [INFO] [stderr] Compiling criterion v0.3.6 [INFO] [stderr] Compiling pausable_clock v1.0.1 (/opt/rustwide/workdir) [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 8.73s [INFO] running `Command { std: "docker" "inspect" "8726f715ab7783e79e41ffc16541d1ea66a06bd8a30fd998e8cdbbd3c5377580", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "8726f715ab7783e79e41ffc16541d1ea66a06bd8a30fd998e8cdbbd3c5377580", kill_on_drop: false }` [INFO] [stdout] 8726f715ab7783e79e41ffc16541d1ea66a06bd8a30fd998e8cdbbd3c5377580 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/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" "RUSTDOCFLAGS=--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:2788e3201cd34a07e3172128adcd8b3090168a8e3bcc40d7c032b9dda1df7d1c" "/opt/rustwide/cargo-home/bin/cargo" "+ff2c56344c764af598ad33027e9c7a48881808ef" "test" "--frozen", kill_on_drop: false }` [INFO] [stdout] 46e5b21f739195f5175985a62ceab607d9c4acd12fb5991ae1fbb4b0cfcf30f3 [INFO] running `Command { std: "docker" "start" "-a" "46e5b21f739195f5175985a62ceab607d9c4acd12fb5991ae1fbb4b0cfcf30f3", kill_on_drop: false }` [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 0.04s [INFO] [stderr] Running unittests src/lib.rs (/opt/rustwide/target/debug/deps/pausable_clock-305f0946d4196474) [INFO] [stdout] [INFO] [stdout] running 14 tests [INFO] [stdout] test pausable_instant::tests::test_checked_add ... ok [INFO] [stdout] test pausable_instant::tests::test_duration_since ... ok [INFO] [stdout] test pausable_instant::tests::test_checked_sub ... ok [INFO] [stdout] test pause_state::tests::test_accurate_millis ... ok [INFO] [stdout] test pausable_instant::tests::test_duration_since_fail - should panic ... ok [INFO] [stdout] test pausable_instant::tests::test_elapsed_fail - should panic ... ok [INFO] [stdout] test tests::test_unpausable_wont_run_while_paused ... ok [INFO] [stdout] test tests::it_works ... ok [INFO] [stdout] test tests::test_pause_blocks_until_unpausable_exits ... ok [INFO] [stdout] test tests::test_resume_blocks_until_unresumable_exits ... ok [INFO] [stdout] test pausable_instant::tests::test_elapsed ... ok [INFO] [stdout] test tests::test_start_paused ... ok [INFO] [stdout] test tests::test_multiple_pauses ... ok [INFO] [stdout] test tests::test_time_max_when_paused ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 14 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 3.88s [INFO] [stdout] [INFO] [stderr] Doc-tests pausable_clock [INFO] [stdout] [INFO] [stdout] running 1 test [INFO] [stdout] test src/lib.rs - (line 34) ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 1 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 1.22s [INFO] [stdout] [INFO] running `Command { std: "docker" "inspect" "46e5b21f739195f5175985a62ceab607d9c4acd12fb5991ae1fbb4b0cfcf30f3", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "46e5b21f739195f5175985a62ceab607d9c4acd12fb5991ae1fbb4b0cfcf30f3", kill_on_drop: false }` [INFO] [stdout] 46e5b21f739195f5175985a62ceab607d9c4acd12fb5991ae1fbb4b0cfcf30f3 [INFO] testing pausable_clock-1.0.1 against try#5e4273472e1b2f223618a9b3def795f6224f241d for pr-118825 [INFO] extracting crate pausable_clock 1.0.1 into /workspace/builds/worker-5-tc2/source [INFO] validating manifest of crates.io crate pausable_clock 1.0.1 on toolchain 5e4273472e1b2f223618a9b3def795f6224f241d [INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+5e4273472e1b2f223618a9b3def795f6224f241d" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }` [INFO] started tweaking crates.io crate pausable_clock 1.0.1 [INFO] finished tweaking crates.io crate pausable_clock 1.0.1 [INFO] tweaked toml for crates.io crate pausable_clock 1.0.1 written to /workspace/builds/worker-5-tc2/source/Cargo.toml [INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+5e4273472e1b2f223618a9b3def795f6224f241d" "generate-lockfile" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] [stderr] Updating crates.io index [INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+5e4273472e1b2f223618a9b3def795f6224f241d" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/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:2788e3201cd34a07e3172128adcd8b3090168a8e3bcc40d7c032b9dda1df7d1c" "/opt/rustwide/cargo-home/bin/cargo" "+5e4273472e1b2f223618a9b3def795f6224f241d" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }` [INFO] [stdout] 4e71c06f6f635649508f0b8156b57ba1df0e6c8fe87d1899390ab71eadcc395b [INFO] running `Command { std: "docker" "start" "-a" "4e71c06f6f635649508f0b8156b57ba1df0e6c8fe87d1899390ab71eadcc395b", kill_on_drop: false }` [INFO] running `Command { std: "docker" "inspect" "4e71c06f6f635649508f0b8156b57ba1df0e6c8fe87d1899390ab71eadcc395b", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "4e71c06f6f635649508f0b8156b57ba1df0e6c8fe87d1899390ab71eadcc395b", kill_on_drop: false }` [INFO] [stdout] 4e71c06f6f635649508f0b8156b57ba1df0e6c8fe87d1899390ab71eadcc395b [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/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" "RUSTDOCFLAGS=--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:2788e3201cd34a07e3172128adcd8b3090168a8e3bcc40d7c032b9dda1df7d1c" "/opt/rustwide/cargo-home/bin/cargo" "+5e4273472e1b2f223618a9b3def795f6224f241d" "build" "--frozen" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 63f03e3cfa008952c403c1d794c34529c805f81bb970034883c674b92ddefb51 [INFO] running `Command { std: "docker" "start" "-a" "63f03e3cfa008952c403c1d794c34529c805f81bb970034883c674b92ddefb51", kill_on_drop: false }` [INFO] [stderr] Compiling pausable_clock v1.0.1 (/opt/rustwide/workdir) [INFO] [stderr] Finished dev [unoptimized + debuginfo] target(s) in 0.18s [INFO] running `Command { std: "docker" "inspect" "63f03e3cfa008952c403c1d794c34529c805f81bb970034883c674b92ddefb51", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "63f03e3cfa008952c403c1d794c34529c805f81bb970034883c674b92ddefb51", kill_on_drop: false }` [INFO] [stdout] 63f03e3cfa008952c403c1d794c34529c805f81bb970034883c674b92ddefb51 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/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" "RUSTDOCFLAGS=--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:2788e3201cd34a07e3172128adcd8b3090168a8e3bcc40d7c032b9dda1df7d1c" "/opt/rustwide/cargo-home/bin/cargo" "+5e4273472e1b2f223618a9b3def795f6224f241d" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] cfa3ad0f91048964fdb29814e6273e88f5992da7738b8678033a537e10bb267a [INFO] running `Command { std: "docker" "start" "-a" "cfa3ad0f91048964fdb29814e6273e88f5992da7738b8678033a537e10bb267a", kill_on_drop: false }` [INFO] [stderr] Compiling memoffset v0.9.0 [INFO] [stderr] Compiling serde v1.0.193 [INFO] [stderr] Compiling crossbeam-utils v0.8.17 [INFO] [stderr] Compiling num-traits v0.2.17 [INFO] [stderr] Compiling rayon-core v1.12.0 [INFO] [stderr] Compiling serde_json v1.0.108 [INFO] [stderr] Compiling libc v0.2.151 [INFO] [stderr] Compiling unicode-width v0.1.11 [INFO] [stderr] Compiling memchr v2.6.4 [INFO] [stderr] Compiling plotters-backend v0.3.5 [INFO] [stderr] Compiling regex-syntax v0.8.2 [INFO] [stderr] Compiling same-file v1.0.6 [INFO] [stderr] Compiling cast v0.3.0 [INFO] [stderr] Compiling half v1.8.2 [INFO] [stderr] Compiling oorandom v11.1.3 [INFO] [stderr] Compiling syn v2.0.41 [INFO] [stderr] Compiling textwrap v0.11.0 [INFO] [stderr] Compiling walkdir v2.4.0 [INFO] [stderr] Compiling plotters-svg v0.3.5 [INFO] [stderr] Compiling criterion-plot v0.4.5 [INFO] [stderr] Compiling clap v2.34.0 [INFO] [stderr] Compiling csv-core v0.1.11 [INFO] [stderr] Compiling crossbeam-epoch v0.9.16 [INFO] [stderr] Compiling crossbeam-deque v0.8.4 [INFO] [stderr] Compiling atty v0.2.14 [INFO] [stderr] Compiling regex-automata v0.4.3 [INFO] [stderr] Compiling rayon v1.8.0 [INFO] [stderr] Compiling plotters v0.3.5 [INFO] [stderr] Compiling regex v1.10.2 [INFO] [stderr] Compiling serde_cbor v0.11.2 [INFO] [stderr] Compiling csv v1.3.0 [INFO] [stderr] Compiling tinytemplate v1.2.1 [INFO] [stderr] Compiling serde_derive v1.0.193 [INFO] [stderr] Compiling criterion v0.3.6 [INFO] [stderr] Compiling pausable_clock v1.0.1 (/opt/rustwide/workdir) [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 13.66s [INFO] running `Command { std: "docker" "inspect" "cfa3ad0f91048964fdb29814e6273e88f5992da7738b8678033a537e10bb267a", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "cfa3ad0f91048964fdb29814e6273e88f5992da7738b8678033a537e10bb267a", kill_on_drop: false }` [INFO] [stdout] cfa3ad0f91048964fdb29814e6273e88f5992da7738b8678033a537e10bb267a [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/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" "RUSTDOCFLAGS=--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:2788e3201cd34a07e3172128adcd8b3090168a8e3bcc40d7c032b9dda1df7d1c" "/opt/rustwide/cargo-home/bin/cargo" "+5e4273472e1b2f223618a9b3def795f6224f241d" "test" "--frozen", kill_on_drop: false }` [INFO] [stdout] 67e59e65ffd72a3950e3f35d32490e4b0f658b55964864db7cc52877fddeab3f [INFO] running `Command { std: "docker" "start" "-a" "67e59e65ffd72a3950e3f35d32490e4b0f658b55964864db7cc52877fddeab3f", kill_on_drop: false }` [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 0.06s [INFO] [stderr] Running unittests src/lib.rs (/opt/rustwide/target/debug/deps/pausable_clock-305f0946d4196474) [INFO] [stdout] [INFO] [stdout] running 14 tests [INFO] [stdout] test pausable_instant::tests::test_checked_add ... ok [INFO] [stdout] test pausable_instant::tests::test_checked_sub ... ok [INFO] [stdout] test pausable_instant::tests::test_duration_since ... ok [INFO] [stdout] test pause_state::tests::test_accurate_millis ... ok [INFO] [stdout] test pausable_instant::tests::test_duration_since_fail - should panic ... ok [INFO] [stdout] test pausable_instant::tests::test_elapsed_fail - should panic ... ok [INFO] [stdout] test tests::test_pause_blocks_until_unpausable_exits ... FAILED [INFO] [stdout] test tests::test_resume_blocks_until_unresumable_exits ... FAILED [INFO] [stdout] test tests::test_unpausable_wont_run_while_paused ... ok [INFO] [stdout] test tests::it_works ... ok [INFO] [stdout] test tests::test_start_paused ... ok [INFO] [stdout] test pausable_instant::tests::test_elapsed ... FAILED [INFO] [stdout] test tests::test_time_max_when_paused ... ok [INFO] [stdout] test tests::test_multiple_pauses ... ok [INFO] [stdout] [INFO] [stdout] failures: [INFO] [stdout] [INFO] [stdout] ---- tests::test_pause_blocks_until_unpausable_exits stdout ---- [INFO] [stdout] thread 'tests::test_pause_blocks_until_unpausable_exits' panicked at src/lib.rs:1017:9: [INFO] [stdout] assertion `left == right` failed [INFO] [stdout] left: 1 [INFO] [stdout] right: 0 [INFO] [stdout] stack backtrace: [INFO] [stdout] 0: 0x55e801ddb3bc - std::backtrace_rs::backtrace::libunwind::trace::he911f9c907837597 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/../../backtrace/src/backtrace/libunwind.rs:104:5 [INFO] [stdout] 1: 0x55e801ddb3bc - std::backtrace_rs::backtrace::trace_unsynchronized::hb30926ceb4a5ace8 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/../../backtrace/src/backtrace/mod.rs:66:5 [INFO] [stdout] 2: 0x55e801ddb3bc - std::sys_common::backtrace::_print_fmt::h20b4c3cb4b8e01de [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:68:5 [INFO] [stdout] 3: 0x55e801ddb3bc - ::fmt::hcb347474accdbb50 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:44:22 [INFO] [stdout] 4: 0x55e801e050d0 - core::fmt::rt::Argument::fmt::h0959df1f48ddd7a2 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/fmt/rt.rs:142:9 [INFO] [stdout] 5: 0x55e801e050d0 - core::fmt::write::hb02961b4380cf4e7 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/fmt/mod.rs:1120:17 [INFO] [stdout] 6: 0x55e801dd8d7f - std::io::Write::write_fmt::h529bf90db5fd4c64 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/io/mod.rs:1810:15 [INFO] [stdout] 7: 0x55e801ddb1a4 - std::sys_common::backtrace::_print::h9f31dc4772e05e46 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:47:5 [INFO] [stdout] 8: 0x55e801ddb1a4 - std::sys_common::backtrace::print::he1974c4a8ca14219 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:34:9 [INFO] [stdout] 9: 0x55e801ddced7 - std::panicking::default_hook::{{closure}}::h9663c9f0f27e933c [INFO] [stdout] 10: 0x55e801ddcbc3 - std::panicking::default_hook::h232155e937189ed1 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:289:9 [INFO] [stdout] 11: 0x55e801dad3a7 - as core::ops::function::Fn>::call::h30a8b128ee88d398 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/alloc/src/boxed.rs:2029:9 [INFO] [stdout] 12: 0x55e801dad3a7 - test::test_main::{{closure}}::hcafb25d50378ac2e [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:138:21 [INFO] [stdout] 13: 0x55e801ddd4e8 - as core::ops::function::Fn>::call::hb0500737c93e9fc8 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/alloc/src/boxed.rs:2029:9 [INFO] [stdout] 14: 0x55e801ddd4e8 - std::panicking::rust_panic_with_hook::hc8764d1694e821a7 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:783:13 [INFO] [stdout] 15: 0x55e801ddd23e - std::panicking::begin_panic_handler::{{closure}}::hf3ed629468815f4d [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:657:13 [INFO] [stdout] 16: 0x55e801ddb886 - std::sys_common::backtrace::__rust_end_short_backtrace::h4e08af68b8432e1a [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:171:18 [INFO] [stdout] 17: 0x55e801ddcfa2 - rust_begin_unwind [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:645:5 [INFO] [stdout] 18: 0x55e801d53cf5 - core::panicking::panic_fmt::hd274135c92cc1bf8 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/panicking.rs:72:14 [INFO] [stdout] 19: 0x55e801d5403b - core::panicking::assert_failed_inner::h0e7060ac34fab196 [INFO] [stdout] 20: 0x55e801d5f0ee - core::panicking::assert_failed::h1436a545723e457a [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/panicking.rs:297:5 [INFO] [stdout] 21: 0x55e801d6e942 - pausable_clock::tests::test_pause_blocks_until_unpausable_exits::h5df0f8827836637b [INFO] [stdout] at /opt/rustwide/workdir/src/lib.rs:1017:9 [INFO] [stdout] 22: 0x55e801d6e337 - pausable_clock::tests::test_pause_blocks_until_unpausable_exits::{{closure}}::h40d50c73671e410d [INFO] [stdout] at /opt/rustwide/workdir/src/lib.rs:975:50 [INFO] [stdout] 23: 0x55e801d620f6 - core::ops::function::FnOnce::call_once::h83c456ec6fc0b4d0 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/ops/function.rs:250:5 [INFO] [stdout] 24: 0x55e801db2a9f - core::ops::function::FnOnce::call_once::he101e5838844b848 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/ops/function.rs:250:5 [INFO] [stdout] 25: 0x55e801db2a9f - test::__rust_begin_short_backtrace::hed21417c1aa71a94 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:627:18 [INFO] [stdout] 26: 0x55e801db1a15 - test::run_test_in_process::{{closure}}::h46df11f5a11dd433 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:650:60 [INFO] [stdout] 27: 0x55e801db1a15 - as core::ops::function::FnOnce<()>>::call_once::ha2e64525433f53a7 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/panic/unwind_safe.rs:272:9 [INFO] [stdout] 28: 0x55e801db1a15 - std::panicking::try::do_call::hb1d734fe97663a7f [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:552:40 [INFO] [stdout] 29: 0x55e801db1a15 - std::panicking::try::h9d066276df30f924 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:516:19 [INFO] [stdout] 30: 0x55e801db1a15 - std::panic::catch_unwind::heaada02e29cd999e [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panic.rs:142:14 [INFO] [stdout] 31: 0x55e801db1a15 - test::run_test_in_process::hcb05ee14075e628d [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:650:27 [INFO] [stdout] 32: 0x55e801db1a15 - test::run_test::{{closure}}::hf9413b0f448cd684 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:573:43 [INFO] [stdout] 33: 0x55e801d79c56 - test::run_test::{{closure}}::h1bb15d2e8774a33f [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:601:41 [INFO] [stdout] 34: 0x55e801d79c56 - std::sys_common::backtrace::__rust_begin_short_backtrace::h530f23a50d8639c1 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:155:18 [INFO] [stdout] 35: 0x55e801d7ee37 - std::thread::Builder::spawn_unchecked_::{{closure}}::{{closure}}::h37b8455d57d25f70 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/thread/mod.rs:529:17 [INFO] [stdout] 36: 0x55e801d7ee37 - as core::ops::function::FnOnce<()>>::call_once::h3867791011bf949d [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/panic/unwind_safe.rs:272:9 [INFO] [stdout] 37: 0x55e801d7ee37 - std::panicking::try::do_call::h1cac0f1203e6219b [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:552:40 [INFO] [stdout] 38: 0x55e801d7ee37 - std::panicking::try::h82de9f14e7a5f0ca [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:516:19 [INFO] [stdout] 39: 0x55e801d7ee37 - std::panic::catch_unwind::hcea1081d521eaa80 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panic.rs:142:14 [INFO] [stdout] 40: 0x55e801d7ee37 - std::thread::Builder::spawn_unchecked_::{{closure}}::ha7aa8f4eaae79bb5 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/thread/mod.rs:528:30 [INFO] [stdout] 41: 0x55e801d7ee37 - core::ops::function::FnOnce::call_once{{vtable.shim}}::h5c1a4829e968af7c [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/ops/function.rs:250:5 [INFO] [stdout] 42: 0x55e801de1f45 - as core::ops::function::FnOnce>::call_once::h6cea6bfb156e0019 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/alloc/src/boxed.rs:2015:9 [INFO] [stdout] 43: 0x55e801de1f45 - as core::ops::function::FnOnce>::call_once::h3c499441c8da3187 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/alloc/src/boxed.rs:2015:9 [INFO] [stdout] 44: 0x55e801de1f45 - std::sys::unix::thread::Thread::new::thread_start::h45692980afba103a [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys/unix/thread.rs:108:17 [INFO] [stdout] 45: 0x7f2b5c572ac3 - [INFO] [stdout] 46: 0x7f2b5c603bf4 - __clone [INFO] [stdout] 47: 0x0 - [INFO] [stdout] [INFO] [stdout] ---- tests::test_resume_blocks_until_unresumable_exits stdout ---- [INFO] [stdout] thread 'tests::test_resume_blocks_until_unresumable_exits' panicked at src/lib.rs:1072:9: [INFO] [stdout] assertion `left == right` failed [INFO] [stdout] left: 1 [INFO] [stdout] right: 0 [INFO] [stdout] stack backtrace: [INFO] [stdout] 0: 0x55e801ddb3bc - std::backtrace_rs::backtrace::libunwind::trace::he911f9c907837597 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/../../backtrace/src/backtrace/libunwind.rs:104:5 [INFO] [stdout] 1: 0x55e801ddb3bc - std::backtrace_rs::backtrace::trace_unsynchronized::hb30926ceb4a5ace8 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/../../backtrace/src/backtrace/mod.rs:66:5 [INFO] [stdout] 2: 0x55e801ddb3bc - std::sys_common::backtrace::_print_fmt::h20b4c3cb4b8e01de [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:68:5 [INFO] [stdout] 3: 0x55e801ddb3bc - ::fmt::hcb347474accdbb50 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:44:22 [INFO] [stdout] 4: 0x55e801e050d0 - core::fmt::rt::Argument::fmt::h0959df1f48ddd7a2 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/fmt/rt.rs:142:9 [INFO] [stdout] 5: 0x55e801e050d0 - core::fmt::write::hb02961b4380cf4e7 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/fmt/mod.rs:1120:17 [INFO] [stdout] 6: 0x55e801dd8d7f - std::io::Write::write_fmt::h529bf90db5fd4c64 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/io/mod.rs:1810:15 [INFO] [stdout] 7: 0x55e801ddb1a4 - std::sys_common::backtrace::_print::h9f31dc4772e05e46 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:47:5 [INFO] [stdout] 8: 0x55e801ddb1a4 - std::sys_common::backtrace::print::he1974c4a8ca14219 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:34:9 [INFO] [stdout] 9: 0x55e801ddced7 - std::panicking::default_hook::{{closure}}::h9663c9f0f27e933c [INFO] [stdout] 10: 0x55e801ddcbc3 - std::panicking::default_hook::h232155e937189ed1 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:289:9 [INFO] [stdout] 11: 0x55e801dad3a7 - as core::ops::function::Fn>::call::h30a8b128ee88d398 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/alloc/src/boxed.rs:2029:9 [INFO] [stdout] 12: 0x55e801dad3a7 - test::test_main::{{closure}}::hcafb25d50378ac2e [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:138:21 [INFO] [stdout] 13: 0x55e801ddd4e8 - as core::ops::function::Fn>::call::hb0500737c93e9fc8 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/alloc/src/boxed.rs:2029:9 [INFO] [stdout] 14: 0x55e801ddd4e8 - std::panicking::rust_panic_with_hook::hc8764d1694e821a7 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:783:13 [INFO] [stdout] 15: 0x55e801ddd23e - std::panicking::begin_panic_handler::{{closure}}::hf3ed629468815f4d [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:657:13 [INFO] [stdout] 16: 0x55e801ddb886 - std::sys_common::backtrace::__rust_end_short_backtrace::h4e08af68b8432e1a [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:171:18 [INFO] [stdout] 17: 0x55e801ddcfa2 - rust_begin_unwind [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:645:5 [INFO] [stdout] 18: 0x55e801d53cf5 - core::panicking::panic_fmt::hd274135c92cc1bf8 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/panicking.rs:72:14 [INFO] [stdout] 19: 0x55e801d5403b - core::panicking::assert_failed_inner::h0e7060ac34fab196 [INFO] [stdout] 20: 0x55e801d5f0ee - core::panicking::assert_failed::h1436a545723e457a [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/panicking.rs:297:5 [INFO] [stdout] 21: 0x55e801d6f488 - pausable_clock::tests::test_resume_blocks_until_unresumable_exits::h2e9daf632298f269 [INFO] [stdout] at /opt/rustwide/workdir/src/lib.rs:1072:9 [INFO] [stdout] 22: 0x55e801d6ee37 - pausable_clock::tests::test_resume_blocks_until_unresumable_exits::{{closure}}::h07ca41853fea09b0 [INFO] [stdout] at /opt/rustwide/workdir/src/lib.rs:1030:52 [INFO] [stdout] 23: 0x55e801d621c6 - core::ops::function::FnOnce::call_once::ha2b32672632549f5 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/ops/function.rs:250:5 [INFO] [stdout] 24: 0x55e801db2a9f - core::ops::function::FnOnce::call_once::he101e5838844b848 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/ops/function.rs:250:5 [INFO] [stdout] 25: 0x55e801db2a9f - test::__rust_begin_short_backtrace::hed21417c1aa71a94 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:627:18 [INFO] [stdout] 26: 0x55e801db1a15 - test::run_test_in_process::{{closure}}::h46df11f5a11dd433 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:650:60 [INFO] [stdout] 27: 0x55e801db1a15 - as core::ops::function::FnOnce<()>>::call_once::ha2e64525433f53a7 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/panic/unwind_safe.rs:272:9 [INFO] [stdout] 28: 0x55e801db1a15 - std::panicking::try::do_call::hb1d734fe97663a7f [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:552:40 [INFO] [stdout] 29: 0x55e801db1a15 - std::panicking::try::h9d066276df30f924 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:516:19 [INFO] [stdout] 30: 0x55e801db1a15 - std::panic::catch_unwind::heaada02e29cd999e [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panic.rs:142:14 [INFO] [stdout] 31: 0x55e801db1a15 - test::run_test_in_process::hcb05ee14075e628d [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:650:27 [INFO] [stdout] 32: 0x55e801db1a15 - test::run_test::{{closure}}::hf9413b0f448cd684 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:573:43 [INFO] [stdout] 33: 0x55e801d79c56 - test::run_test::{{closure}}::h1bb15d2e8774a33f [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:601:41 [INFO] [stdout] 34: 0x55e801d79c56 - std::sys_common::backtrace::__rust_begin_short_backtrace::h530f23a50d8639c1 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:155:18 [INFO] [stdout] 35: 0x55e801d7ee37 - std::thread::Builder::spawn_unchecked_::{{closure}}::{{closure}}::h37b8455d57d25f70 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/thread/mod.rs:529:17 [INFO] [stdout] 36: 0x55e801d7ee37 - as core::ops::function::FnOnce<()>>::call_once::h3867791011bf949d [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/panic/unwind_safe.rs:272:9 [INFO] [stdout] 37: 0x55e801d7ee37 - std::panicking::try::do_call::h1cac0f1203e6219b [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:552:40 [INFO] [stdout] 38: 0x55e801d7ee37 - std::panicking::try::h82de9f14e7a5f0ca [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:516:19 [INFO] [stdout] 39: 0x55e801d7ee37 - std::panic::catch_unwind::hcea1081d521eaa80 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panic.rs:142:14 [INFO] [stdout] 40: 0x55e801d7ee37 - std::thread::Builder::spawn_unchecked_::{{closure}}::ha7aa8f4eaae79bb5 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/thread/mod.rs:528:30 [INFO] [stdout] 41: 0x55e801d7ee37 - core::ops::function::FnOnce::call_once{{vtable.shim}}::h5c1a4829e968af7c [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/ops/function.rs:250:5 [INFO] [stdout] 42: 0x55e801de1f45 - as core::ops::function::FnOnce>::call_once::h6cea6bfb156e0019 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/alloc/src/boxed.rs:2015:9 [INFO] [stdout] 43: 0x55e801de1f45 - as core::ops::function::FnOnce>::call_once::h3c499441c8da3187 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/alloc/src/boxed.rs:2015:9 [INFO] [stdout] 44: 0x55e801de1f45 - std::sys::unix::thread::Thread::new::thread_start::h45692980afba103a [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys/unix/thread.rs:108:17 [INFO] [stdout] 45: 0x7f2b5c572ac3 - [INFO] [stdout] 46: 0x7f2b5c603bf4 - __clone [INFO] [stdout] 47: 0x0 - [INFO] [stdout] [INFO] [stdout] ---- pausable_instant::tests::test_elapsed stdout ---- [INFO] [stdout] thread 'pausable_instant::tests::test_elapsed' panicked at src/pausable_instant.rs:228:9: [INFO] [stdout] assertion failed: (expected_elapsed.as_secs_f64() - 1.0).abs() < 0.005 [INFO] [stdout] stack backtrace: [INFO] [stdout] 0: 0x55e801ddb3bc - std::backtrace_rs::backtrace::libunwind::trace::he911f9c907837597 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/../../backtrace/src/backtrace/libunwind.rs:104:5 [INFO] [stdout] 1: 0x55e801ddb3bc - std::backtrace_rs::backtrace::trace_unsynchronized::hb30926ceb4a5ace8 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/../../backtrace/src/backtrace/mod.rs:66:5 [INFO] [stdout] 2: 0x55e801ddb3bc - std::sys_common::backtrace::_print_fmt::h20b4c3cb4b8e01de [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:68:5 [INFO] [stdout] 3: 0x55e801ddb3bc - ::fmt::hcb347474accdbb50 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:44:22 [INFO] [stdout] 4: 0x55e801e050d0 - core::fmt::rt::Argument::fmt::h0959df1f48ddd7a2 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/fmt/rt.rs:142:9 [INFO] [stdout] 5: 0x55e801e050d0 - core::fmt::write::hb02961b4380cf4e7 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/fmt/mod.rs:1120:17 [INFO] [stdout] 6: 0x55e801dd8d7f - std::io::Write::write_fmt::h529bf90db5fd4c64 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/io/mod.rs:1810:15 [INFO] [stdout] 7: 0x55e801ddb1a4 - std::sys_common::backtrace::_print::h9f31dc4772e05e46 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:47:5 [INFO] [stdout] 8: 0x55e801ddb1a4 - std::sys_common::backtrace::print::he1974c4a8ca14219 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:34:9 [INFO] [stdout] 9: 0x55e801ddced7 - std::panicking::default_hook::{{closure}}::h9663c9f0f27e933c [INFO] [stdout] 10: 0x55e801ddcbc3 - std::panicking::default_hook::h232155e937189ed1 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:289:9 [INFO] [stdout] 11: 0x55e801dad3a7 - as core::ops::function::Fn>::call::h30a8b128ee88d398 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/alloc/src/boxed.rs:2029:9 [INFO] [stdout] 12: 0x55e801dad3a7 - test::test_main::{{closure}}::hcafb25d50378ac2e [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:138:21 [INFO] [stdout] 13: 0x55e801ddd4e8 - as core::ops::function::Fn>::call::hb0500737c93e9fc8 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/alloc/src/boxed.rs:2029:9 [INFO] [stdout] 14: 0x55e801ddd4e8 - std::panicking::rust_panic_with_hook::hc8764d1694e821a7 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:783:13 [INFO] [stdout] 15: 0x55e801ddd209 - std::panicking::begin_panic_handler::{{closure}}::hf3ed629468815f4d [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:649:13 [INFO] [stdout] 16: 0x55e801ddb886 - std::sys_common::backtrace::__rust_end_short_backtrace::h4e08af68b8432e1a [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:171:18 [INFO] [stdout] 17: 0x55e801ddcfa2 - rust_begin_unwind [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:645:5 [INFO] [stdout] 18: 0x55e801d53cf5 - core::panicking::panic_fmt::hd274135c92cc1bf8 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/panicking.rs:72:14 [INFO] [stdout] 19: 0x55e801d53db3 - core::panicking::panic::hdb514ca351aed0df [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/panicking.rs:144:5 [INFO] [stdout] 20: 0x55e801d66470 - pausable_clock::pausable_instant::tests::test_elapsed::h87b2a7101dd1fcb0 [INFO] [stdout] at /opt/rustwide/workdir/src/pausable_instant.rs:228:9 [INFO] [stdout] 21: 0x55e801d662d7 - pausable_clock::pausable_instant::tests::test_elapsed::{{closure}}::hc5479f5388fb787f [INFO] [stdout] at /opt/rustwide/workdir/src/pausable_instant.rs:213:22 [INFO] [stdout] 22: 0x55e801d61f26 - core::ops::function::FnOnce::call_once::h148e6a84335187f4 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/ops/function.rs:250:5 [INFO] [stdout] 23: 0x55e801db2a9f - core::ops::function::FnOnce::call_once::he101e5838844b848 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/ops/function.rs:250:5 [INFO] [stdout] 24: 0x55e801db2a9f - test::__rust_begin_short_backtrace::hed21417c1aa71a94 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:627:18 [INFO] [stdout] 25: 0x55e801db1a15 - test::run_test_in_process::{{closure}}::h46df11f5a11dd433 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:650:60 [INFO] [stdout] 26: 0x55e801db1a15 - as core::ops::function::FnOnce<()>>::call_once::ha2e64525433f53a7 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/panic/unwind_safe.rs:272:9 [INFO] [stdout] 27: 0x55e801db1a15 - std::panicking::try::do_call::hb1d734fe97663a7f [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:552:40 [INFO] [stdout] 28: 0x55e801db1a15 - std::panicking::try::h9d066276df30f924 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:516:19 [INFO] [stdout] 29: 0x55e801db1a15 - std::panic::catch_unwind::heaada02e29cd999e [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panic.rs:142:14 [INFO] [stdout] 30: 0x55e801db1a15 - test::run_test_in_process::hcb05ee14075e628d [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:650:27 [INFO] [stdout] 31: 0x55e801db1a15 - test::run_test::{{closure}}::hf9413b0f448cd684 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:573:43 [INFO] [stdout] 32: 0x55e801d79c56 - test::run_test::{{closure}}::h1bb15d2e8774a33f [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/test/src/lib.rs:601:41 [INFO] [stdout] 33: 0x55e801d79c56 - std::sys_common::backtrace::__rust_begin_short_backtrace::h530f23a50d8639c1 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys_common/backtrace.rs:155:18 [INFO] [stdout] 34: 0x55e801d7ee37 - std::thread::Builder::spawn_unchecked_::{{closure}}::{{closure}}::h37b8455d57d25f70 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/thread/mod.rs:529:17 [INFO] [stdout] 35: 0x55e801d7ee37 - as core::ops::function::FnOnce<()>>::call_once::h3867791011bf949d [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/panic/unwind_safe.rs:272:9 [INFO] [stdout] 36: 0x55e801d7ee37 - std::panicking::try::do_call::h1cac0f1203e6219b [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:552:40 [INFO] [stdout] 37: 0x55e801d7ee37 - std::panicking::try::h82de9f14e7a5f0ca [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panicking.rs:516:19 [INFO] [stdout] 38: 0x55e801d7ee37 - std::panic::catch_unwind::hcea1081d521eaa80 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/panic.rs:142:14 [INFO] [stdout] 39: 0x55e801d7ee37 - std::thread::Builder::spawn_unchecked_::{{closure}}::ha7aa8f4eaae79bb5 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/thread/mod.rs:528:30 [INFO] [stdout] 40: 0x55e801d7ee37 - core::ops::function::FnOnce::call_once{{vtable.shim}}::h5c1a4829e968af7c [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/core/src/ops/function.rs:250:5 [INFO] [stdout] 41: 0x55e801de1f45 - as core::ops::function::FnOnce>::call_once::h6cea6bfb156e0019 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/alloc/src/boxed.rs:2015:9 [INFO] [stdout] 42: 0x55e801de1f45 - as core::ops::function::FnOnce>::call_once::h3c499441c8da3187 [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/alloc/src/boxed.rs:2015:9 [INFO] [stdout] 43: 0x55e801de1f45 - std::sys::unix::thread::Thread::new::thread_start::h45692980afba103a [INFO] [stdout] at /rustc/5e4273472e1b2f223618a9b3def795f6224f241d/library/std/src/sys/unix/thread.rs:108:17 [INFO] [stdout] 44: 0x7f2b5c572ac3 - [INFO] [stdout] 45: 0x7f2b5c603bf4 - __clone [INFO] [stdout] 46: 0x0 - [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] failures: [INFO] [stdout] pausable_instant::tests::test_elapsed [INFO] [stdout] tests::test_pause_blocks_until_unpausable_exits [INFO] [stdout] tests::test_resume_blocks_until_unresumable_exits [INFO] [stdout] [INFO] [stdout] test result: FAILED. 11 passed; 3 failed; 0 ignored; 0 measured; 0 filtered out; finished in 4.01s [INFO] [stdout] [INFO] [stderr] error: test failed, to rerun pass `--lib` [INFO] running `Command { std: "docker" "inspect" "67e59e65ffd72a3950e3f35d32490e4b0f658b55964864db7cc52877fddeab3f", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "67e59e65ffd72a3950e3f35d32490e4b0f658b55964864db7cc52877fddeab3f", kill_on_drop: false }` [INFO] [stdout] 67e59e65ffd72a3950e3f35d32490e4b0f658b55964864db7cc52877fddeab3f