[INFO] cloning repository https://github.com/tshlabs/staccato [INFO] running `Command { std: "git" "-c" "credential.helper=" "-c" "credential.helper=/workspace/cargo-home/bin/git-credential-null" "clone" "--bare" "https://github.com/tshlabs/staccato" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2Ftshlabs%2Fstaccato", kill_on_drop: false }` [INFO] [stderr] Cloning into bare repository '/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2Ftshlabs%2Fstaccato'... [INFO] running `Command { std: "git" "rev-parse" "HEAD", kill_on_drop: false }` [INFO] [stdout] 5533ee2c1e61dc782cd944448ef7ca63cadc4d5e [INFO] testing tshlabs/staccato against master#432e145bd5a974c5b6f4dd9b352891bd7502b69d for pr-87041 [INFO] running `Command { std: "git" "clone" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2Ftshlabs%2Fstaccato" "/workspace/builds/worker-12/source", kill_on_drop: false }` [INFO] [stderr] Cloning into '/workspace/builds/worker-12/source'... [INFO] [stderr] done. [INFO] validating manifest of git repo https://github.com/tshlabs/staccato on toolchain 432e145bd5a974c5b6f4dd9b352891bd7502b69d [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+432e145bd5a974c5b6f4dd9b352891bd7502b69d" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }` [INFO] started tweaking git repo https://github.com/tshlabs/staccato [INFO] finished tweaking git repo https://github.com/tshlabs/staccato [INFO] tweaked toml for git repo https://github.com/tshlabs/staccato written to /workspace/builds/worker-12/source/Cargo.toml [INFO] crate git repo https://github.com/tshlabs/staccato already has a lockfile, it will not be regenerated [INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+432e145bd5a974c5b6f4dd9b352891bd7502b69d" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [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" "+432e145bd5a974c5b6f4dd9b352891bd7502b69d" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }` [INFO] [stdout] 895e8fc9da5350d686d1c0211b62935a41dea3add20f215f0310cffeccc4e9ef [INFO] running `Command { std: "docker" "start" "-a" "895e8fc9da5350d686d1c0211b62935a41dea3add20f215f0310cffeccc4e9ef", kill_on_drop: false }` [INFO] running `Command { std: "docker" "inspect" "895e8fc9da5350d686d1c0211b62935a41dea3add20f215f0310cffeccc4e9ef", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "895e8fc9da5350d686d1c0211b62935a41dea3add20f215f0310cffeccc4e9ef", kill_on_drop: false }` [INFO] [stdout] 895e8fc9da5350d686d1c0211b62935a41dea3add20f215f0310cffeccc4e9ef [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" "+432e145bd5a974c5b6f4dd9b352891bd7502b69d" "build" "--frozen" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 33d3c76d0d48107e708a5af173f3bb8fac0d322b878479d06cdbe009fc777d22 [INFO] running `Command { std: "docker" "start" "-a" "33d3c76d0d48107e708a5af173f3bb8fac0d322b878479d06cdbe009fc777d22", kill_on_drop: false }` [INFO] [stderr] Compiling proc-macro2 v1.0.24 [INFO] [stderr] Compiling version_check v0.9.2 [INFO] [stderr] Compiling unicode-xid v0.2.1 [INFO] [stderr] Compiling syn v1.0.48 [INFO] [stderr] Compiling autocfg v1.0.1 [INFO] [stderr] Compiling libc v0.2.80 [INFO] [stderr] Compiling unicode-segmentation v1.6.0 [INFO] [stderr] Compiling bitflags v1.2.1 [INFO] [stderr] Compiling hashbrown v0.9.1 [INFO] [stderr] Compiling unicode-width v0.1.8 [INFO] [stderr] Compiling termcolor v1.1.0 [INFO] [stderr] Compiling vec_map v0.8.2 [INFO] [stderr] Compiling lazy_static v1.4.0 [INFO] [stderr] Compiling strsim v0.10.0 [INFO] [stderr] Compiling os_str_bytes v2.3.2 [INFO] [stderr] Compiling textwrap v0.12.1 [INFO] [stderr] Compiling heck v0.3.1 [INFO] [stderr] Compiling proc-macro-error-attr v1.0.4 [INFO] [stderr] Compiling proc-macro-error v1.0.4 [INFO] [stderr] Compiling indexmap v1.6.0 [INFO] [stderr] Compiling quote v1.0.7 [INFO] [stderr] Compiling atty v0.2.14 [INFO] [stderr] Compiling clap_derive v3.0.0-beta.2 [INFO] [stderr] Compiling clap v3.0.0-beta.2 [INFO] [stderr] Compiling staccato v0.1.9 (/opt/rustwide/workdir) [INFO] [stderr] Finished dev [unoptimized + debuginfo] target(s) in 23.08s [INFO] running `Command { std: "docker" "inspect" "33d3c76d0d48107e708a5af173f3bb8fac0d322b878479d06cdbe009fc777d22", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "33d3c76d0d48107e708a5af173f3bb8fac0d322b878479d06cdbe009fc777d22", kill_on_drop: false }` [INFO] [stdout] 33d3c76d0d48107e708a5af173f3bb8fac0d322b878479d06cdbe009fc777d22 [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" "+432e145bd5a974c5b6f4dd9b352891bd7502b69d" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 1cad9ae97d009f2d476dc76ed98be13b329ac8b03bab0d5db01d4b0ab0f888f4 [INFO] running `Command { std: "docker" "start" "-a" "1cad9ae97d009f2d476dc76ed98be13b329ac8b03bab0d5db01d4b0ab0f888f4", kill_on_drop: false }` [INFO] [stderr] Compiling staccato v0.1.9 (/opt/rustwide/workdir) [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 0.94s [INFO] running `Command { std: "docker" "inspect" "1cad9ae97d009f2d476dc76ed98be13b329ac8b03bab0d5db01d4b0ab0f888f4", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "1cad9ae97d009f2d476dc76ed98be13b329ac8b03bab0d5db01d4b0ab0f888f4", kill_on_drop: false }` [INFO] [stdout] 1cad9ae97d009f2d476dc76ed98be13b329ac8b03bab0d5db01d4b0ab0f888f4 [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" "+432e145bd5a974c5b6f4dd9b352891bd7502b69d" "test" "--frozen", kill_on_drop: false }` [INFO] [stdout] e953c750ca563ad382497858d3aa61c63bc4d59e01f28c0c6a0f8502e8c70c22 [INFO] running `Command { std: "docker" "start" "-a" "e953c750ca563ad382497858d3aa61c63bc4d59e01f28c0c6a0f8502e8c70c22", kill_on_drop: false }` [INFO] [stderr] Blocking waiting for file lock on package cache [INFO] [stderr] Finished test [unoptimized + debuginfo] target(s) in 0.28s [INFO] [stderr] Running unittests (/opt/rustwide/target/debug/deps/staccato-9bc58666eb026701) [INFO] [stdout] [INFO] [stdout] running 29 tests [INFO] [stdout] test tests::test_get_values_trim_whitespace ... ok [INFO] [stdout] test tests::test_get_values_filter_invalids ... ok [INFO] [stdout] test tests::test_get_values_ordered ... ok [INFO] [stdout] test tests::test_get_values_unordered ... ok [INFO] [stdout] test tests::test_key_value_sep_display ... ok [INFO] [stdout] test tests::test_key_value_sep_get_sep ... ok [INFO] [stdout] test tests::test_statistics_50_values_mean ... ok [INFO] [stderr] Running unittests (/opt/rustwide/target/debug/deps/st-561f142c0c0354a7) [INFO] [stdout] test tests::test_key_value_sep_from_str ... ok [INFO] [stdout] test tests::test_statistics_50_values_lower ... ok [INFO] [stdout] test tests::test_statistics_50_values_count ... ok [INFO] [stdout] test tests::test_statistics_50_values_median ... ok [INFO] [stdout] test tests::test_statistics_50_values_sum ... ok [INFO] [stdout] test tests::test_statistics_50_values_upper ... ok [INFO] [stdout] test tests::test_statistics_50_values_stddev ... ok [INFO] [stdout] test tests::test_statistics_full_values_lower ... ok [INFO] [stdout] test tests::test_statistics_full_values_mean ... ok [INFO] [stdout] test tests::test_statistics_full_values_median ... ok [INFO] [stdout] test tests::test_statistics_full_values_stddev ... ok [INFO] [stdout] test tests::test_statistics_full_values_sum ... ok [INFO] [stdout] test tests::test_statistics_full_values_upper ... ok [INFO] [stdout] test tests::test_statistics_single_value_lower ... ok [INFO] [stdout] test tests::test_statistics_single_value_mean ... ok [INFO] [stdout] test tests::test_statistics_empty_values ... ok [INFO] [stdout] test tests::test_statistics_single_value_stddev ... ok [INFO] [stdout] test tests::test_statistics_single_value_median ... ok [INFO] [stdout] test tests::test_statistics_single_value_upper ... ok [INFO] [stdout] test tests::test_statistics_full_values_count ... ok [INFO] [stdout] test tests::test_statistics_single_value_count ... ok [INFO] [stdout] test tests::test_statistics_single_value_sum ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 29 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.01s [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] running 5 tests [INFO] [stdout] test tests::test_parse_percentiles_err_not_a_number ... ok [INFO] [stdout] test tests::test_parse_percentiles_err_not_in_range ... ok [INFO] [stdout] test tests::test_parse_percentiles_upper_bound ... ok [INFO] [stdout] test tests::test_parse_percentiles_ok ... ok [INFO] [stdout] test tests::test_parse_percentiles_lower_bound ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 5 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.00s [INFO] [stdout] [INFO] [stderr] Doc-tests staccato [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" "e953c750ca563ad382497858d3aa61c63bc4d59e01f28c0c6a0f8502e8c70c22", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "e953c750ca563ad382497858d3aa61c63bc4d59e01f28c0c6a0f8502e8c70c22", kill_on_drop: false }` [INFO] [stdout] e953c750ca563ad382497858d3aa61c63bc4d59e01f28c0c6a0f8502e8c70c22