[INFO] fetching crate chonk 0.5.0...
[INFO] testing chonk-0.5.0 against try#d2e9fff28e244f1ea4927194f1f9b77f93e2ffe2 for pr-86479
[INFO] extracting crate chonk 0.5.0 into /workspace/builds/worker-1/source
[INFO] validating manifest of crates.io crate chonk 0.5.0 on toolchain d2e9fff28e244f1ea4927194f1f9b77f93e2ffe2
[INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+d2e9fff28e244f1ea4927194f1f9b77f93e2ffe2" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }`
[INFO] started tweaking crates.io crate chonk 0.5.0
[INFO] finished tweaking crates.io crate chonk 0.5.0
[INFO] tweaked toml for crates.io crate chonk 0.5.0 written to /workspace/builds/worker-1/source/Cargo.toml
[INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+d2e9fff28e244f1ea4927194f1f9b77f93e2ffe2" "generate-lockfile" "--manifest-path" "Cargo.toml" "-Zno-index-update", kill_on_drop: false }`
[INFO] running `Command { std: "/workspace/cargo-home/bin/cargo" "+d2e9fff28e244f1ea4927194f1f9b77f93e2ffe2" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/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" "+d2e9fff28e244f1ea4927194f1f9b77f93e2ffe2" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }`
[INFO] [stdout] c82560a5f4852bbf247b0042ff9150a074450960d0624ab541d91abb30a77a76
[INFO] running `Command { std: "docker" "start" "-a" "c82560a5f4852bbf247b0042ff9150a074450960d0624ab541d91abb30a77a76", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "c82560a5f4852bbf247b0042ff9150a074450960d0624ab541d91abb30a77a76", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "c82560a5f4852bbf247b0042ff9150a074450960d0624ab541d91abb30a77a76", kill_on_drop: false }`
[INFO] [stdout] c82560a5f4852bbf247b0042ff9150a074450960d0624ab541d91abb30a77a76
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/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" "+d2e9fff28e244f1ea4927194f1f9b77f93e2ffe2" "build" "--frozen" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] 9b76376db6375cc4503df9df902d3cfdb38ea45b58daa6d68263a788eac77068
[INFO] running `Command { std: "docker" "start" "-a" "9b76376db6375cc4503df9df902d3cfdb38ea45b58daa6d68263a788eac77068", kill_on_drop: false }`
[INFO] [stderr]    Compiling proc-macro-hack v0.5.19
[INFO] [stderr]    Compiling paste-impl v0.1.18
[INFO] [stderr]    Compiling paste v0.1.18
[INFO] [stderr]    Compiling chonk v0.5.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 6.56s
[INFO] running `Command { std: "docker" "inspect" "9b76376db6375cc4503df9df902d3cfdb38ea45b58daa6d68263a788eac77068", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "9b76376db6375cc4503df9df902d3cfdb38ea45b58daa6d68263a788eac77068", kill_on_drop: false }`
[INFO] [stdout] 9b76376db6375cc4503df9df902d3cfdb38ea45b58daa6d68263a788eac77068
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/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" "+d2e9fff28e244f1ea4927194f1f9b77f93e2ffe2" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] 1597df91623dbddca1fbfcec6060880cf4714eeace72acdec4c2af06ef899c1d
[INFO] running `Command { std: "docker" "start" "-a" "1597df91623dbddca1fbfcec6060880cf4714eeace72acdec4c2af06ef899c1d", kill_on_drop: false }`
[INFO] [stderr]     Blocking waiting for file lock on package cache
[INFO] [stderr]    Compiling chonk v0.5.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished test [unoptimized + debuginfo] target(s) in 5.10s
[INFO] running `Command { std: "docker" "inspect" "1597df91623dbddca1fbfcec6060880cf4714eeace72acdec4c2af06ef899c1d", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "1597df91623dbddca1fbfcec6060880cf4714eeace72acdec4c2af06ef899c1d", kill_on_drop: false }`
[INFO] [stdout] 1597df91623dbddca1fbfcec6060880cf4714eeace72acdec4c2af06ef899c1d
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1/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" "+d2e9fff28e244f1ea4927194f1f9b77f93e2ffe2" "test" "--frozen", kill_on_drop: false }`
[INFO] [stdout] 23d79b9d7fe6d7330df5768a3a0269decf24591aef238f310d0f2d7793cf417f
[INFO] running `Command { std: "docker" "start" "-a" "23d79b9d7fe6d7330df5768a3a0269decf24591aef238f310d0f2d7793cf417f", kill_on_drop: false }`
[INFO] [stderr]     Finished test [unoptimized + debuginfo] target(s) in 0.01s
[INFO] [stderr]      Running unittests (/opt/rustwide/target/debug/deps/chonk-bbc920bd4371edfe)
[INFO] [stdout] 
[INFO] [stdout] running 5 tests
[INFO] [stdout] test framework::context::parser_context_from_parser_result ... ok
[INFO] [stdout] test framework::context::parser_context_from_str ... ok
[INFO] [stderr]      Running tests/context.rs (/opt/rustwide/target/debug/deps/context-579939d736d123b2)
[INFO] [stdout] test framework::error::custom_error_message ... ok
[INFO] [stdout] test framework::context::parser_context_from_string ... ok
[INFO] [stdout] test framework::error::parser_error_with_message ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 5 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 select_character ... ok
[INFO] [stdout] test select_empty ... ok
[INFO] [stdout] test select_first_two_characters ... ok
[INFO] [stdout] test select_first_character ... ok
[INFO] [stderr]      Running tests/matcher.rs (/opt/rustwide/target/debug/deps/matcher-2e4832da0acd7316)
[INFO] [stdout] test select_inset_character ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 5 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.01s
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] running 4 tests
[INFO] [stdout] test end_of_input_matches ... ok
[INFO] [stdout] test is_matches ... ok
[INFO] [stdout] test isnt_matches ... ok
[INFO] [stderr]    Doc-tests chonk
[INFO] [stdout] test start_of_input_matches ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 4 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.01s
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] running 21 tests
[INFO] [stdout] test src/parsers/matching.rs - parsers::matching::find_all (line 121) ... ok
[INFO] [stdout] test src/parsers/delimiting.rs - parsers::delimiting::trim (line 115) ... ok
[INFO] [stdout] test src/parsers/matching.rs - parsers::matching::find_any (line 150) ... ok
[INFO] [stdout] test src/parsers/controlling.rs - parsers::controlling::find_when (line 180) ... ok
[INFO] [stdout] test src/parsers/controlling.rs - parsers::controlling::find_when_not (line 233) ... ok
[INFO] [stdout] test src/parsers/separating.rs - parsers::separating::find_separated (line 54) ... ok
[INFO] [stdout] test src/parsers/matching.rs - parsers::matching::take_any (line 285) ... ok
[INFO] [stdout] test src/parsers/delimiting.rs - parsers::delimiting::left_delimited (line 50) ... ok
[INFO] [stdout] test src/parsers/controlling.rs - parsers::controlling::optional (line 7) ... ok
[INFO] [stdout] test src/parsers/controlling.rs - parsers::controlling::find_when (line 132) ... ok
[INFO] [stdout] test src/parsers/matching.rs - parsers::matching::take_all (line 256) ... ok
[INFO] [stdout] test src/parsers/controlling.rs - parsers::controlling::find_until (line 51) ... ok
[INFO] [stdout] test src/parsers/matching.rs - parsers::matching::space (line 367) ... ok
[INFO] [stdout] test src/parsers/delimiting.rs - parsers::delimiting::delimited (line 7) ... ok
[INFO] [stdout] test src/parsers/controlling.rs - parsers::controlling::find_when (line 102) ... ok
[INFO] [stdout] test src/parsers/matching.rs - parsers::matching::take (line 181) ... ok
[INFO] [stdout] test src/parsers/controlling.rs - parsers::controlling::take_until (line 273) ... ok
[INFO] [stdout] test src/parsers/delimiting.rs - parsers::delimiting::right_delimited (line 79) ... ok
[INFO] [stdout] test src/parsers/separating.rs - parsers::separating::separated (line 9) ... ok
[INFO] [stdout] test src/parsers/matching.rs - parsers::matching::find (line 49) ... ok
[INFO] [stdout] test src/parsers/matching.rs - parsers::matching::empty (line 9) ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 21 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 1.52s
[INFO] [stdout] 
[INFO] running `Command { std: "docker" "inspect" "23d79b9d7fe6d7330df5768a3a0269decf24591aef238f310d0f2d7793cf417f", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "23d79b9d7fe6d7330df5768a3a0269decf24591aef238f310d0f2d7793cf417f", kill_on_drop: false }`
[INFO] [stdout] 23d79b9d7fe6d7330df5768a3a0269decf24591aef238f310d0f2d7793cf417f