[INFO] fetching crate probminhash 0.1.12... [INFO] testing probminhash-0.1.12 against master#caccb4d0368bd918ef6668af8e13834d07040417 for pr-146098-1 [INFO] extracting crate probminhash 0.1.12 into /workspace/builds/worker-6-tc1/source [INFO] started tweaking crates.io crate probminhash 0.1.12 [INFO] finished tweaking crates.io crate probminhash 0.1.12 [INFO] tweaked toml for crates.io crate probminhash 0.1.12 written to /workspace/builds/worker-6-tc1/source/Cargo.toml [INFO] validating manifest of crates.io crate probminhash 0.1.12 on toolchain caccb4d0368bd918ef6668af8e13834d07040417 [INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+caccb4d0368bd918ef6668af8e13834d07040417" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }` [INFO] crate crates.io crate probminhash 0.1.12 already has a lockfile, it will not be regenerated [INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+caccb4d0368bd918ef6668af8e13834d07040417" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] [stderr] Updating crates.io index [INFO] [stderr] Downloading crates ... [INFO] [stderr] Downloaded argmin-math v0.4.0 [INFO] [stderr] Downloaded argmin-observer-slog v0.1.0 [INFO] [stderr] Downloaded katexit v0.1.4 [INFO] [stderr] Downloaded murmur3 v0.5.2 [INFO] [stderr] Downloaded rand_xoshiro v0.7.0 [INFO] [stderr] Downloaded rand_distr v0.5.1 [INFO] [stderr] Downloaded wyhash v0.6.0 [INFO] [stderr] Downloaded twox-hash v2.1.0 [INFO] [stderr] Downloaded slog-term v2.9.1 [INFO] [stderr] Downloaded slog-async v2.8.0 [INFO] [stderr] Downloaded argmin v0.10.0 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-6-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-6-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:e90291280db7d1fac5b66fc6dad9f9662629e7365a55743daf9bdf73ebc4ea79" "/opt/rustwide/cargo-home/bin/cargo" "+caccb4d0368bd918ef6668af8e13834d07040417" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }` [INFO] [stdout] d551058a3bdbf5850b42c8be767eb5a8f2fc7e7fcc4a676287c56f158cd3afd8 [INFO] running `Command { std: "docker" "start" "-a" "d551058a3bdbf5850b42c8be767eb5a8f2fc7e7fcc4a676287c56f158cd3afd8", kill_on_drop: false }` [INFO] running `Command { std: "docker" "inspect" "d551058a3bdbf5850b42c8be767eb5a8f2fc7e7fcc4a676287c56f158cd3afd8", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "d551058a3bdbf5850b42c8be767eb5a8f2fc7e7fcc4a676287c56f158cd3afd8", kill_on_drop: false }` [INFO] [stdout] d551058a3bdbf5850b42c8be767eb5a8f2fc7e7fcc4a676287c56f158cd3afd8 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-6-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-6-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:e90291280db7d1fac5b66fc6dad9f9662629e7365a55743daf9bdf73ebc4ea79" "/opt/rustwide/cargo-home/bin/cargo" "+caccb4d0368bd918ef6668af8e13834d07040417" "build" "--frozen" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 208085ccd32c3e02fe4943d9b83e5d14e913ea7ed236a0ddee29b642c7a87cae [INFO] running `Command { std: "docker" "start" "-a" "208085ccd32c3e02fe4943d9b83e5d14e913ea7ed236a0ddee29b642c7a87cae", kill_on_drop: false }` [INFO] [stderr] Compiling libm v0.2.11 [INFO] [stderr] Compiling getrandom v0.3.2 [INFO] [stderr] Compiling slog v2.7.0 [INFO] [stderr] Compiling num-traits v0.2.19 [INFO] [stderr] Compiling dirs-sys-next v0.1.2 [INFO] [stderr] Compiling regex-syntax v0.8.5 [INFO] [stderr] Compiling time-macros v0.2.22 [INFO] [stderr] Compiling deranged v0.4.1 [INFO] [stderr] Compiling syn v2.0.100 [INFO] [stderr] Compiling slog-async v2.8.0 [INFO] [stderr] Compiling rand_xoshiro v0.6.0 [INFO] [stderr] Compiling crossbeam-channel v0.5.14 [INFO] [stderr] Compiling instant v0.1.13 [INFO] [stderr] Compiling take_mut v0.2.2 [INFO] [stderr] Compiling syn v1.0.109 [INFO] [stderr] Compiling indexmap v2.9.0 [INFO] [stderr] Compiling sha2 v0.10.8 [INFO] [stderr] Compiling fxhash v0.2.1 [INFO] [stderr] Compiling twox-hash v2.1.0 [INFO] [stderr] Compiling dirs-next v2.0.0 [INFO] [stderr] Compiling term v0.7.0 [INFO] [stderr] Compiling murmur3 v0.5.2 [INFO] [stderr] Compiling rand_core v0.9.3 [INFO] [stderr] Compiling rand_chacha v0.9.0 [INFO] [stderr] Compiling wyhash v0.6.0 [INFO] [stderr] Compiling rand_xoshiro v0.7.0 [INFO] [stderr] Compiling rand_xorshift v0.4.0 [INFO] [stderr] Compiling rand v0.9.0 [INFO] [stderr] Compiling num-integer v0.1.46 [INFO] [stderr] Compiling num-complex v0.4.6 [INFO] [stderr] Compiling regex-automata v0.4.9 [INFO] [stderr] Compiling num-bigint v0.4.6 [INFO] [stderr] Compiling num-iter v0.1.45 [INFO] [stderr] Compiling rand_distr v0.5.1 [INFO] [stderr] Compiling time v0.3.41 [INFO] [stderr] Compiling thiserror-impl v1.0.69 [INFO] [stderr] Compiling serde_derive v1.0.219 [INFO] [stderr] Compiling slog-term v2.9.1 [INFO] [stderr] Compiling thiserror v1.0.69 [INFO] [stderr] Compiling argmin-math v0.4.0 [INFO] [stderr] Compiling argmin v0.10.0 [INFO] [stderr] Compiling num-rational v0.4.2 [INFO] [stderr] Compiling katexit v0.1.4 [INFO] [stderr] Compiling regex v1.11.1 [INFO] [stderr] Compiling num v0.4.3 [INFO] [stderr] Compiling env_filter v0.1.3 [INFO] [stderr] Compiling env_logger v0.11.7 [INFO] [stderr] Compiling serde v1.0.219 [INFO] [stderr] Compiling argmin-observer-slog v0.1.0 [INFO] [stderr] Compiling serde_json v1.0.140 [INFO] [stderr] Compiling probminhash v0.1.12 (/opt/rustwide/workdir) [INFO] [stderr] Finished `dev` profile [unoptimized + debuginfo] target(s) in 19.50s [INFO] running `Command { std: "docker" "inspect" "208085ccd32c3e02fe4943d9b83e5d14e913ea7ed236a0ddee29b642c7a87cae", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "208085ccd32c3e02fe4943d9b83e5d14e913ea7ed236a0ddee29b642c7a87cae", kill_on_drop: false }` [INFO] [stdout] 208085ccd32c3e02fe4943d9b83e5d14e913ea7ed236a0ddee29b642c7a87cae [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-6-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-6-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:e90291280db7d1fac5b66fc6dad9f9662629e7365a55743daf9bdf73ebc4ea79" "/opt/rustwide/cargo-home/bin/cargo" "+caccb4d0368bd918ef6668af8e13834d07040417" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] ca98b2ce1234671266d4da7450901c0fa0e8c28cb5b0de2513ec78cd99296971 [INFO] running `Command { std: "docker" "start" "-a" "ca98b2ce1234671266d4da7450901c0fa0e8c28cb5b0de2513ec78cd99296971", kill_on_drop: false }` [INFO] [stderr] Compiling probminhash v0.1.12 (/opt/rustwide/workdir) [INFO] [stderr] Finished `test` profile [unoptimized + debuginfo] target(s) in 3.65s [INFO] running `Command { std: "docker" "inspect" "ca98b2ce1234671266d4da7450901c0fa0e8c28cb5b0de2513ec78cd99296971", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "ca98b2ce1234671266d4da7450901c0fa0e8c28cb5b0de2513ec78cd99296971", kill_on_drop: false }` [INFO] [stdout] ca98b2ce1234671266d4da7450901c0fa0e8c28cb5b0de2513ec78cd99296971 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-6-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-6-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:e90291280db7d1fac5b66fc6dad9f9662629e7365a55743daf9bdf73ebc4ea79" "/opt/rustwide/cargo-home/bin/cargo" "+caccb4d0368bd918ef6668af8e13834d07040417" "test" "--frozen", kill_on_drop: false }` [INFO] [stdout] 2b24cdff2d131aae701991636a55673eaa09e6f42500f01ff5e255b2a9cd70ae [INFO] running `Command { std: "docker" "start" "-a" "2b24cdff2d131aae701991636a55673eaa09e6f42500f01ff5e255b2a9cd70ae", kill_on_drop: false }` [INFO] [stderr] Finished `test` profile [unoptimized + debuginfo] target(s) in 0.16s [INFO] [stderr] Running unittests src/lib.rs (/opt/rustwide/target/debug/deps/probminhash-78b09d11272d34e5) [INFO] [stdout] [INFO] [stdout] running 38 tests [INFO] [stdout] test probminhasher::probminhash2::tests::test_probminhash2_count_intersection_equal_weights ... ok [INFO] [stdout] test probminhasher::probordminhash2::tests::ordminhash2_equality ... ok [INFO] [stdout] test probminhasher::probminhash3::tests::test_probminhash3_count_intersection_equal_weights ... ok [INFO] [stdout] test maxvaluetrack::tests::test_max_value_tracker ... ok [INFO] [stdout] test probminhasher::probminhash2::tests::test_probminhash2_count_intersection_unequal_weights ... ok [INFO] [stdout] test probminhasher::probminhash3sha::tests::test_probminhash3asha_count_intersection_unequal_weights ... ok [INFO] [stdout] test probminhasher::probminhash3::tests::test_probminhash3a_count_intersection_unequal_weights ... ok [INFO] [stdout] test probminhasher::probminhash3::tests::test_probminhash3_count_intersection_unequal_weights ... ok [INFO] [stdout] test invhash::tests::test_inversible_hash_32 ... ok [INFO] [stdout] test fyshuffle::tests::test_fyshuffle_1 ... ok [INFO] [stderr] Oct 01 17:24:30.468 INFO Golden-section search [INFO] [stderr] Oct 01 17:24:30.468 INFO iter: 0, cost: 4237.223905296585, best_cost: 4237.223905296585, cost_count: 3, time: 0.00000344 [INFO] [stderr] Oct 01 17:24:30.468 INFO iter: 1, cost: 4237.223905296585, best_cost: 4237.223905296585, cost_count: 4, time: 0.00000224 [INFO] [stderr] Oct 01 17:24:30.468 INFO iter: 2, cost: 4237.1395287851665, best_cost: 4237.1395287851665, cost_count: 5, time: 0.00000198 [INFO] [stderr] Oct 01 17:24:30.468 INFO iter: 3, cost: 4237.1395287851665, best_cost: 4237.1395287851665, cost_count: 6, time: 0.00000197 [INFO] [stderr] Oct 01 17:24:30.468 INFO iter: 4, cost: 4237.1395287851665, best_cost: 4237.1395287851665, cost_count: 7, time: 0.00000206 [INFO] [stderr] Oct 01 17:24:30.468 INFO iter: 5, cost: 4237.1395287851665, best_cost: 4237.1395287851665, cost_count: 8, time: 0.00000188 [INFO] [stderr] Oct 01 17:24:30.468 INFO iter: 6, cost: 4237.136900504765, best_cost: 4237.136900504765, cost_count: 9, time: 0.00000208 [INFO] [stderr] Oct 01 17:24:30.468 INFO iter: 7, cost: 4237.136900504765, best_cost: 4237.136900504765, cost_count: 10, time: 0.0000019 [INFO] [stderr] Oct 01 17:24:30.468 INFO iter: 8, cost: 4237.136900504765, best_cost: 4237.136900504765, cost_count: 11, time: 0.00000205 [INFO] [stderr] Oct 01 17:24:30.468 INFO iter: 9, cost: 4237.136900504765, best_cost: 4237.136900504765, cost_count: 12, time: 0.00000181 [INFO] [stderr] Oct 01 17:24:30.468 INFO iter: 10, cost: 4237.136900504765, best_cost: 4237.136900504765, cost_count: 13, time: 0.00000201 [INFO] [stdout] test setsketcher::tests::test_mle_1 ... ok [INFO] [stdout] test setsketcher::tests::test_params_bounds ... ok [INFO] [stdout] test invhash::tests::test_inversible_hash_64 ... ok [INFO] [stdout] test setsketcher::tests::test_range_inter1_hll_fnv_f32 ... ok [INFO] [stdout] test superminhasher2::tests::test_build_hasher ... ok [INFO] [stdout] test superminhasher2::tests::test_range_intersection_already_hashed_u64 ... ok [INFO] [stdout] test densminhash::tests::test_optdens_fewbins_fnv_f64 ... ok [INFO] [stdout] test probminhasher::probordminhash2::tests::ordminhash2_random_data ... ok [INFO] [stdout] test superminhasher::tests::test_build_hasher ... ok [INFO] [stdout] test superminhasher::tests::test_range_intersection_already_hashed_f32 ... ok [INFO] [stdout] test superminhasher::tests::test_range_intersection_already_hashed_f64 ... ok [INFO] [stdout] test superminhasher::tests::test_range_intersection_fnv_f32 ... ok [INFO] [stdout] test superminhasher2::tests::test_range_intersection_fnv_u64 ... ok [INFO] [stdout] test exp01::tests::test_exp01 ... ok [INFO] [stdout] test setsketcher::tests::test_hll_card_with_repetition ... ok [INFO] [stdout] test setsketcher::tests::test_merge_1 ... ok [INFO] [stdout] test superminhasher::tests::test_range_intersection_fnv_f64 ... ok [INFO] [stdout] test fyshuffle::tests::test_fyshuffle_2 ... ok [INFO] [stdout] test setsketcher::tests::test_range_inter2_hll_fnv_f32 ... ok [INFO] [stdout] test superminhasher2::tests::test_range_intersection_fnv_u32 ... ok [INFO] [stdout] test densminhash::tests::test_revoptdens_fewbins_fnv_f64 ... ok [INFO] [stdout] test densminhash::tests::test_optdens_manybins_fnv_f64 has been running for over 60 seconds [INFO] [stdout] test densminhash::tests::test_revoptdens_manybins_fnv_f64 has been running for over 60 seconds [INFO] [stdout] test probminhasher::probordminhash2::tests::test_ordminhash2_p1 has been running for over 60 seconds [INFO] [stdout] test probminhasher::probordminhash2::tests::test_ordminhash2_p2 has been running for over 60 seconds [INFO] [stdout] test probminhasher::probordminhash2::tests::test_ordminhash2_p3 has been running for over 60 seconds [INFO] [stdout] test probminhasher::probordminhash2::tests::test_ordminhash2_p5 has been running for over 60 seconds [INFO] [stdout] test probminhasher::probordminhash2::tests::test_ordminhash_01seq has been running for over 60 seconds [INFO] [stdout] test probminhasher::probordminhash2::tests::test_ordminhash2_p5 ... ok [INFO] [stdout] test probminhasher::probordminhash2::tests::test_ordminhash_01seq ... ok [INFO] [stdout] test densminhash::tests::test_optdens_manybins_fnv_f64 ... ok [ERROR] error running command: no output for 300 seconds [INFO] running `Command { std: "docker" "inspect" "2b24cdff2d131aae701991636a55673eaa09e6f42500f01ff5e255b2a9cd70ae", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "2b24cdff2d131aae701991636a55673eaa09e6f42500f01ff5e255b2a9cd70ae", kill_on_drop: false }` [INFO] [stdout] 2b24cdff2d131aae701991636a55673eaa09e6f42500f01ff5e255b2a9cd70ae