Nov 16 19:45:21.221 INFO testing mhspradlin/lines against try#2e026d6e5d7621634147ad4c8074f1d964dbb1be for pr-55982
Nov 16 19:45:21.221 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-55982/worker-2/try#2e026d6e5d7621634147ad4c8074f1d964dbb1be:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-2/pr-55982/try#2e026d6e5d7621634147ad4c8074f1d964dbb1be:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +2e026d6e5d7621634147ad4c8074f1d964dbb1be-alt build --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Nov 16 19:45:21.413 INFO [stdout] e46c07aa664de03b6e4145da96e84676f3d94078d2e8ec9f1dc4551c8899afc1
Nov 16 19:45:21.415 INFO running `"docker" "start" "-a" "e46c07aa664de03b6e4145da96e84676f3d94078d2e8ec9f1dc4551c8899afc1"`
Nov 16 19:45:21.939 INFO [stderr] usermod: no changes
Nov 16 19:45:22.172 INFO [stderr]    Compiling cc v1.0.6
Nov 16 19:45:22.175 INFO [stderr]    Compiling serde v1.0.29
Nov 16 19:45:22.175 INFO [stderr]    Compiling log-mdc v0.1.0
Nov 16 19:45:22.175 INFO [stderr]    Compiling cadence v0.13.2
Nov 16 19:45:22.176 INFO [stderr]    Compiling ordered-float v0.5.0
Nov 16 19:45:22.177 INFO [stderr]    Compiling statsd v0.10.0
Nov 16 19:45:22.179 INFO [stderr]    Compiling serde_derive_internals v0.20.0
Nov 16 19:45:22.179 INFO [stderr]    Compiling structopt-derive v0.2.6
Nov 16 19:45:26.007 INFO [stderr]    Compiling chrono v0.4.0
Nov 16 19:45:26.007 INFO [stderr]    Compiling rayon v0.9.0
Nov 16 19:45:33.355 INFO [stderr]    Compiling backtrace-sys v0.1.16
Nov 16 19:45:33.355 INFO [stderr]    Compiling miniz-sys v0.1.10
Nov 16 19:45:39.739 INFO [stderr]    Compiling serde_derive v1.0.29
Nov 16 19:45:40.415 INFO [stderr]    Compiling flate2 v1.0.1
Nov 16 19:45:40.431 INFO [stderr]    Compiling structopt v0.2.6
Nov 16 19:45:56.935 INFO [stderr]    Compiling log v0.4.1
Nov 16 19:45:56.935 INFO [stderr]    Compiling serde-value v0.5.1
Nov 16 19:45:56.936 INFO [stderr]    Compiling serde_json v1.0.10
Nov 16 19:45:56.936 INFO [stderr]    Compiling serde_yaml v0.7.3
Nov 16 19:45:56.936 INFO [stderr]    Compiling serde-humantime v0.1.1
Nov 16 19:45:58.739 INFO [stderr]    Compiling env_logger v0.5.6
Nov 16 19:46:05.220 INFO [stderr]    Compiling backtrace v0.3.5
Nov 16 19:46:07.867 INFO [stderr]    Compiling failure v0.1.1
Nov 16 19:46:08.207 INFO [stderr]    Compiling log4rs v0.8.0
Nov 16 19:46:09.233 INFO [stderr]    Compiling quicli v0.2.0
Nov 16 19:46:22.421 INFO [stderr]    Compiling lines v0.1.0 (/source)
Nov 16 19:46:25.782 INFO [stderr] warning: unused `#[macro_use]` import
Nov 16 19:46:25.783 INFO [stderr]  --> src/bin/lines-agent.rs:3:1
Nov 16 19:46:25.783 INFO [stderr]   |
Nov 16 19:46:25.783 INFO [stderr] 3 | #[macro_use]
Nov 16 19:46:25.784 INFO [stderr]   | ^^^^^^^^^^^^
Nov 16 19:46:25.784 INFO [stderr]   |
Nov 16 19:46:25.784 INFO [stderr]   = note: #[warn(unused_imports)] on by default
Nov 16 19:46:25.784 INFO [stderr] 
Nov 16 19:46:25.785 INFO [stderr] warning: unused `#[macro_use]` import
Nov 16 19:46:25.785 INFO [stderr]  --> src/bin/lines-agent.rs:5:1
Nov 16 19:46:25.786 INFO [stderr]   |
Nov 16 19:46:25.786 INFO [stderr] 5 | #[macro_use]
Nov 16 19:46:25.786 INFO [stderr]   | ^^^^^^^^^^^^
Nov 16 19:46:25.786 INFO [stderr] 
Nov 16 19:46:31.515 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 1m 09s
Nov 16 19:46:31.523 INFO [stderr] su: No module specific data is present
Nov 16 19:46:32.215 INFO running `"docker" "inspect" "e46c07aa664de03b6e4145da96e84676f3d94078d2e8ec9f1dc4551c8899afc1"`
Nov 16 19:46:32.557 INFO running `"docker" "rm" "-f" "e46c07aa664de03b6e4145da96e84676f3d94078d2e8ec9f1dc4551c8899afc1"`
Nov 16 19:46:33.007 INFO [stdout] e46c07aa664de03b6e4145da96e84676f3d94078d2e8ec9f1dc4551c8899afc1
Nov 16 19:46:33.015 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-55982/worker-2/try#2e026d6e5d7621634147ad4c8074f1d964dbb1be:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-2/pr-55982/try#2e026d6e5d7621634147ad4c8074f1d964dbb1be:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +2e026d6e5d7621634147ad4c8074f1d964dbb1be-alt test --frozen --no-run" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Nov 16 19:46:33.501 INFO [stdout] c4bdc3267428c6bd15f4de991a09c05f5def4855007d37e643aaa455208c1f29
Nov 16 19:46:33.502 INFO running `"docker" "start" "-a" "c4bdc3267428c6bd15f4de991a09c05f5def4855007d37e643aaa455208c1f29"`
Nov 16 19:46:34.635 INFO [stderr] usermod: no changes
Nov 16 19:46:34.847 INFO [stderr]    Compiling lines v0.1.0 (/source)
Nov 16 19:46:37.069 INFO [stderr] warning: unused `#[macro_use]` import
Nov 16 19:46:37.069 INFO [stderr]  --> src/bin/lines-agent.rs:3:1
Nov 16 19:46:37.070 INFO [stderr]   |
Nov 16 19:46:37.070 INFO [stderr] 3 | #[macro_use]
Nov 16 19:46:37.070 INFO [stderr]   | ^^^^^^^^^^^^
Nov 16 19:46:37.070 INFO [stderr]   |
Nov 16 19:46:37.071 INFO [stderr]   = note: #[warn(unused_imports)] on by default
Nov 16 19:46:37.071 INFO [stderr] 
Nov 16 19:46:37.071 INFO [stderr] warning: unused `#[macro_use]` import
Nov 16 19:46:37.072 INFO [stderr]  --> src/bin/lines-agent.rs:5:1
Nov 16 19:46:37.072 INFO [stderr]   |
Nov 16 19:46:37.073 INFO [stderr] 5 | #[macro_use]
Nov 16 19:46:37.073 INFO [stderr]   | ^^^^^^^^^^^^
Nov 16 19:46:37.073 INFO [stderr] 
Nov 16 19:46:38.852 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 4.19s
Nov 16 19:46:38.861 INFO [stderr] su: No module specific data is present
Nov 16 19:46:39.095 INFO running `"docker" "inspect" "c4bdc3267428c6bd15f4de991a09c05f5def4855007d37e643aaa455208c1f29"`
Nov 16 19:46:39.162 INFO running `"docker" "rm" "-f" "c4bdc3267428c6bd15f4de991a09c05f5def4855007d37e643aaa455208c1f29"`
Nov 16 19:46:39.278 INFO [stdout] c4bdc3267428c6bd15f4de991a09c05f5def4855007d37e643aaa455208c1f29
Nov 16 19:46:39.283 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-55982/worker-2/try#2e026d6e5d7621634147ad4c8074f1d964dbb1be:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-2/pr-55982/try#2e026d6e5d7621634147ad4c8074f1d964dbb1be:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +2e026d6e5d7621634147ad4c8074f1d964dbb1be-alt test --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"`
Nov 16 19:46:39.459 INFO [stdout] e8b6f2253ff993542fdd28756745ee32b63b665c541a3c4a2a1cfad33e8bf87f
Nov 16 19:46:39.461 INFO running `"docker" "start" "-a" "e8b6f2253ff993542fdd28756745ee32b63b665c541a3c4a2a1cfad33e8bf87f"`
Nov 16 19:46:40.127 INFO [stderr] usermod: no changes
Nov 16 19:46:40.291 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 0.13s
Nov 16 19:46:40.314 INFO [stderr]      Running /target/debug/deps/lines-cf6eec8f7d981e35
Nov 16 19:46:40.318 INFO [stderr]      Running /target/debug/deps/lines_agent-2195cd1ebd3b9a42
Nov 16 19:46:40.318 INFO [stdout] 
Nov 16 19:46:40.318 INFO [stdout] running 0 tests
Nov 16 19:46:40.318 INFO [stdout] 
Nov 16 19:46:40.318 INFO [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Nov 16 19:46:40.318 INFO [stdout] 
Nov 16 19:46:40.324 INFO [stdout] 
Nov 16 19:46:40.324 INFO [stdout] running 2 tests
Nov 16 19:46:40.331 INFO [stdout] test substitute_variables_substitutes_hostname_and_url ... ok
Nov 16 19:46:40.333 INFO [stdout] test substitute_bindings_in_string_test ... ok
Nov 16 19:46:40.333 INFO [stderr]    Doc-tests lines
Nov 16 19:46:40.333 INFO [stdout] 
Nov 16 19:46:40.333 INFO [stdout] test result: ok. 2 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Nov 16 19:46:40.333 INFO [stdout] 
Nov 16 19:46:40.968 INFO [stdout] 
Nov 16 19:46:40.968 INFO [stdout] running 0 tests
Nov 16 19:46:40.968 INFO [stdout] 
Nov 16 19:46:40.968 INFO [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Nov 16 19:46:40.968 INFO [stdout] 
Nov 16 19:46:40.974 INFO [stderr] su: No module specific data is present
Nov 16 19:46:41.321 INFO running `"docker" "inspect" "e8b6f2253ff993542fdd28756745ee32b63b665c541a3c4a2a1cfad33e8bf87f"`
Nov 16 19:46:41.440 INFO running `"docker" "rm" "-f" "e8b6f2253ff993542fdd28756745ee32b63b665c541a3c4a2a1cfad33e8bf87f"`
Nov 16 19:46:41.567 INFO [stdout] e8b6f2253ff993542fdd28756745ee32b63b665c541a3c4a2a1cfad33e8bf87f