[INFO] fetching crate mry 0.1.8... [INFO] testing mry-0.1.8 against beta-2022-02-22 for beta-1.60-1 [INFO] extracting crate mry 0.1.8 into /workspace/builds/worker-101/source [INFO] validating manifest of crates.io crate mry 0.1.8 on toolchain beta-2022-02-22 [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+beta-2022-02-22" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }` [INFO] started tweaking crates.io crate mry 0.1.8 [INFO] finished tweaking crates.io crate mry 0.1.8 [INFO] tweaked toml for crates.io crate mry 0.1.8 written to /workspace/builds/worker-101/source/Cargo.toml [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+beta-2022-02-22" "generate-lockfile" "--manifest-path" "Cargo.toml" "-Zno-index-update", kill_on_drop: false }` [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+beta-2022-02-22" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-101/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-101/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:0cd99ca24d8e8c98e67c542213511d985b8778b5bdcbb160e038429496686047" "/opt/rustwide/cargo-home/bin/cargo" "+beta-2022-02-22" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }` [INFO] [stdout] 38732a45500eb55d9348e29f8a9dd2505f3756b04b1139dcc319523612580d77 [INFO] running `Command { std: "docker" "start" "-a" "38732a45500eb55d9348e29f8a9dd2505f3756b04b1139dcc319523612580d77", kill_on_drop: false }` [INFO] running `Command { std: "docker" "inspect" "38732a45500eb55d9348e29f8a9dd2505f3756b04b1139dcc319523612580d77", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "38732a45500eb55d9348e29f8a9dd2505f3756b04b1139dcc319523612580d77", kill_on_drop: false }` [INFO] [stdout] 38732a45500eb55d9348e29f8a9dd2505f3756b04b1139dcc319523612580d77 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-101/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-101/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=warn" "-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:0cd99ca24d8e8c98e67c542213511d985b8778b5bdcbb160e038429496686047" "/opt/rustwide/cargo-home/bin/cargo" "+beta-2022-02-22" "build" "--frozen" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 8bd91c8b5d9ca164aa20cf086d9547789525634a9df9283642d157da505821f2 [INFO] running `Command { std: "docker" "start" "-a" "8bd91c8b5d9ca164aa20cf086d9547789525634a9df9283642d157da505821f2", kill_on_drop: false }` [INFO] [stderr] Compiling syn v1.0.86 [INFO] [stderr] Compiling parking_lot_core v0.8.5 [INFO] [stderr] Compiling once_cell v1.9.0 [INFO] [stderr] Compiling instant v0.1.12 [INFO] [stderr] Compiling parking_lot v0.11.2 [INFO] [stderr] Compiling mry_macros v0.1.8 [INFO] [stderr] Compiling async-recursion v0.3.2 [INFO] [stderr] Compiling mry v0.1.8 (/opt/rustwide/workdir) [INFO] [stderr] Finished dev [unoptimized + debuginfo] target(s) in 10.12s [INFO] running `Command { std: "docker" "inspect" "8bd91c8b5d9ca164aa20cf086d9547789525634a9df9283642d157da505821f2", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "8bd91c8b5d9ca164aa20cf086d9547789525634a9df9283642d157da505821f2", kill_on_drop: false }` [INFO] [stdout] 8bd91c8b5d9ca164aa20cf086d9547789525634a9df9283642d157da505821f2 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-101/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-101/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=warn" "-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:0cd99ca24d8e8c98e67c542213511d985b8778b5bdcbb160e038429496686047" "/opt/rustwide/cargo-home/bin/cargo" "+beta-2022-02-22" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 33a8a2da68bd38055169789464c42cb4da89a5a682dbe9fdc213338067a91213 [INFO] running `Command { std: "docker" "start" "-a" "33a8a2da68bd38055169789464c42cb4da89a5a682dbe9fdc213338067a91213", kill_on_drop: false }` [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] [stderr] Compiling version_check v0.9.4 [INFO] [stderr] Compiling futures-core v0.3.21 [INFO] [stderr] Compiling memchr v2.4.1 [INFO] [stderr] Compiling cache-padded v1.2.0 [INFO] [stderr] Compiling log v0.4.14 [INFO] [stderr] Compiling fastrand v1.7.0 [INFO] [stderr] Compiling parking v2.0.0 [INFO] [stderr] Compiling futures-io v0.3.21 [INFO] [stderr] Compiling waker-fn v1.1.0 [INFO] [stderr] Compiling event-listener v2.5.2 [INFO] [stderr] Compiling slab v0.4.5 [INFO] [stderr] Compiling async-task v4.1.0 [INFO] [stderr] Compiling crossbeam-utils v0.8.7 [INFO] [stderr] Compiling atomic-waker v1.0.0 [INFO] [stderr] Compiling async-trait v0.1.52 [INFO] [stderr] Compiling pin-utils v0.1.0 [INFO] [stderr] Compiling socket2 v0.4.4 [INFO] [stderr] Compiling ctor v0.1.21 [INFO] [stderr] Compiling async-attributes v1.1.2 [INFO] [stderr] Compiling concurrent-queue v1.2.2 [INFO] [stderr] Compiling async-mutex v1.4.0 [INFO] [stderr] Compiling async-lock v2.5.0 [INFO] [stderr] Compiling value-bag v1.0.0-alpha.8 [INFO] [stderr] Compiling async-channel v1.6.1 [INFO] [stderr] Compiling futures-lite v1.12.0 [INFO] [stderr] Compiling async-executor v1.4.1 [INFO] [stderr] Compiling blocking v1.1.0 [INFO] [stderr] Compiling polling v2.2.0 [INFO] [stderr] Compiling kv-log-macro v1.0.7 [INFO] [stderr] Compiling async-io v1.6.0 [INFO] [stderr] Compiling async-global-executor v2.0.2 [INFO] [stderr] Compiling async-std v1.10.0 [INFO] [stderr] Compiling mry v0.1.8 (/opt/rustwide/workdir) [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 40.56s [INFO] running `Command { std: "docker" "inspect" "33a8a2da68bd38055169789464c42cb4da89a5a682dbe9fdc213338067a91213", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "33a8a2da68bd38055169789464c42cb4da89a5a682dbe9fdc213338067a91213", kill_on_drop: false }` [INFO] [stdout] 33a8a2da68bd38055169789464c42cb4da89a5a682dbe9fdc213338067a91213 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-101/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-101/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=warn" "-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:0cd99ca24d8e8c98e67c542213511d985b8778b5bdcbb160e038429496686047" "/opt/rustwide/cargo-home/bin/cargo" "+beta-2022-02-22" "test" "--frozen", kill_on_drop: false }` [INFO] [stdout] 3d15482e05eeea25498578dfda1ede56296cf3da6693475ca3c1e0872122e501 [INFO] running `Command { std: "docker" "start" "-a" "3d15482e05eeea25498578dfda1ede56296cf3da6693475ca3c1e0872122e501", kill_on_drop: false }` [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 0.12s [INFO] [stdout] [INFO] [stderr] Running unittests (/opt/rustwide/target/debug/deps/mry-40de951c0f943e71) [INFO] [stdout] running 60 tests [INFO] [stdout] test mock::logs::test::filter_matches ... ok [INFO] [stdout] test mock::logs::test::is_empty ... ok [INFO] [stdout] test mock::mock_result::test::times_within ... ok [INFO] [stdout] test mock::mock_result::test::times ... ok [INFO] [stdout] test mock::test::assert_called_returns_logs ... ok [INFO] [stdout] test mock::test::assert_called_returns_logs_matching ... ok [INFO] [stdout] test mock::test::assert_called_with ... ok [INFO] [stdout] test mock::mock_result::test::times_panics - should panic ... ok [INFO] [stdout] test mock::mock_result::test::times_within_panics - should panic ... ok [INFO] [stdout] test mock::test::assert_called_with_panics - should panic ... ok [INFO] [stdout] test mock::test::assert_called_with_not_eq - should panic ... ok [INFO] [stdout] test mock::test::assert_called_with_log - should panic ... ok [INFO] [stdout] test mock::test::calls_real_impl ... ok [INFO] [stdout] test mock::test::calls_real_impl_never - should panic ... ok [INFO] [stdout] test mock::test::mock_not_found_with_rules - should panic ... ok [INFO] [stdout] test mock::test::returns ... ok [INFO] [stdout] test mock::test::returns_always ... ok [INFO] [stdout] test mock::test::returns_never - should panic ... ok [INFO] [stdout] test mock::test::returns_with_always ... ok [INFO] [stdout] test mock::test::returns_with ... ok [INFO] [stdout] test mock::test::returns_with_never - should panic ... ok [INFO] [stdout] test mocks::test::get_mut_or_create_returns_an_item ... ok [INFO] [stdout] test mocks::test::get_returns_none ... ok [INFO] [stdout] test mocks::test::get_mut_or_create_returns_default ... ok [INFO] [stdout] test mry::test::inner_called_returns_none_when_no_mocks ... ok [INFO] [stdout] test mry::test::clone ... ok [INFO] [stdout] test mry::test::inner_called_forwards_to_mock ... ok [INFO] [stdout] test mry::test::generate_create_mock ... ok [INFO] [stdout] test mocks::test::get_returns_an_item ... ok [INFO] [stdout] test mry::test::generate_does_not_overwrite ... ok [INFO] [stdout] test mry::test::mry_always_equal_ord ... ok [INFO] [stdout] test mry::test::mry_always_equal ... ok [INFO] [stdout] test mry::test::mry_always_equal_partial_ord ... ok [INFO] [stdout] test mry::test::mry_default_is_none ... ok [INFO] [stdout] test mry::test::mry_hash_returns_consistent_value ... ok [INFO] [stdout] test mry::test::mry_unique ... ok [INFO] [stdout] test rule::behavior::tests::calls_real_impl ... ok [INFO] [stdout] test rule::behavior::tests::const_value ... ok [INFO] [stdout] test rule::behavior::tests::debug_calls_real_impl ... ok [INFO] [stdout] test rule::behavior::tests::debug_const ... ok [INFO] [stdout] test rule::behavior::tests::function ... ok [INFO] [stdout] test rule::behavior::tests::debug_function ... ok [INFO] [stdout] test rule::matcher::tests::to_owned ... ok [INFO] [stdout] test rule::matcher::tests::from_str ... ok [INFO] [stdout] test rule::matcher::tests::matcher_two_values ... ok [INFO] [stdout] test rule::test::called_returns_none ... ok [INFO] [stdout] test rule::test::called_returns_some ... ok [INFO] [stdout] test static_mocks::tests::__lock_and_run_delete_mocks_on_free ... ok [INFO] [stdout] test static_mocks::tests::__lock_and_run_just_runs ... ok [INFO] [stdout] test static_mocks::tests::__lock_and_run_locks ... ok [INFO] [stdout] test static_mocks::tests::__mutexes_creates_mutexes ... ok [INFO] [stdout] test static_mocks::tests::__mutexes_does_not_overwrite_mutexes ... ok [INFO] [stdout] test static_mocks::tests::__mutexes_sorts_keys ... ok [INFO] [stdout] test static_mocks::tests::delete_mock_when_lock_is_dropped ... ok [INFO] [stdout] test static_mocks::tests::panic_if_lock_is_not_acquired_mut - should panic ... ok [INFO] [stdout] test static_mocks::tests::panic_if_lock_is_not_created - should panic ... ok [INFO] [stdout] test static_mocks::tests::panic_if_lock_is_not_created_mut - should panic ... ok [INFO] [stdout] test static_mocks::tests::panic_if_lock_is_not_acquired - should panic ... ok [INFO] [stdout] test static_mocks::tests::returns_none_if_not_mocked ... ok [INFO] [stdout] test static_mocks::tests::returns_some_if_mocked ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 60 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.09s [INFO] [stdout] [INFO] [stderr] Running tests/integration/main.rs (/opt/rustwide/target/debug/deps/integration-b260d7a3ccd956c6) [INFO] [stdout] [INFO] [stdout] running 30 tests [INFO] [stdout] test function_style_macro::assert_called ... ok [INFO] [stdout] test impl_trait::meow_returns_with ... ok [INFO] [stdout] test iterator::with_mock ... ok [INFO] [stdout] test function_style_macro::meow_returns_with ... ok [INFO] [stdout] test mock_trait::respects_default ... ok [INFO] [stdout] test mock_trait::with_mock ... ok [INFO] [stdout] test not_clone::not_clone ... ok [INFO] [stdout] test partial_mock::partial_mock ... ok [INFO] [stdout] test nested_mock::nested_mock ... ok [INFO] [stdout] test reference_and_pattern::meow_returns_with ... ok [INFO] [stdout] test simple_case::assert_called ... ok [INFO] [stdout] test simple_case::just_meow_returns ... ok [INFO] [stdout] test simple_case::just_meow_returns_with ... ok [INFO] [stdout] test simple_case::keeps_original_function ... ok [INFO] [stdout] test simple_case::meow_returns ... ok [INFO] [stdout] test simple_case::meow_returns_with ... ok [INFO] [stdout] test simple_case::times ... ok [INFO] [stdout] test simple_case::times_within ... ok [INFO] [stdout] test static_function::function_keeps_original_function ... ok [INFO] [stdout] test static_function::hello_returns ... ok [INFO] [stdout] test static_function::static_method_keeps_original_function ... ok [INFO] [stdout] test mock_trait::no_mock - should panic ... ok [INFO] [stdout] test simple_case::assert_called_fails - should panic ... ok [INFO] [stdout] test static_function::hello_not_used - should panic ... ok [INFO] [stdout] test static_function::meow_returns ... ok [INFO] [stdout] test static_function::under_test_attr ... ok [INFO] [stdout] test async_method::meow_returns_with ... ok [INFO] [stdout] test async_trait::meow_called ... ok [INFO] [stdout] test static_function::static_async_method_keeps_original_function ... ok [INFO] [stdout] test static_function::async_test ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 30 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.20s [INFO] [stdout] [INFO] [stderr] Doc-tests mry [INFO] [stdout] [INFO] [stdout] running 0 tests [INFO] [stdout] [INFO] [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.00s [INFO] [stdout] [INFO] running `Command { std: "docker" "inspect" "3d15482e05eeea25498578dfda1ede56296cf3da6693475ca3c1e0872122e501", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "3d15482e05eeea25498578dfda1ede56296cf3da6693475ca3c1e0872122e501", kill_on_drop: false }` [INFO] [stdout] 3d15482e05eeea25498578dfda1ede56296cf3da6693475ca3c1e0872122e501