Nov 17 21:54:55.034 INFO testing stache-0.2.0 against master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c for pr-55982
Nov 17 21:54:55.034 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-55982/worker-5/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-5/pr-55982/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/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 +6b9b97bd9b704f85f0184f7a213cc4d62bd9654c-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 17 21:54:55.473 INFO [stdout] 37d8775b0f0d1edbdf0db315c5d4a6e7ef536bf50f8218c3ae62bccd86a65e6e
Nov 17 21:54:55.479 INFO running `"docker" "start" "-a" "37d8775b0f0d1edbdf0db315c5d4a6e7ef536bf50f8218c3ae62bccd86a65e6e"`
Nov 17 21:54:56.892 INFO [stderr] usermod: no changes
Nov 17 21:54:57.031 INFO [stderr]    Compiling stache v0.2.0 (/source)
Nov 17 21:55:03.119 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 6.19s
Nov 17 21:55:03.121 INFO [stderr] su: No module specific data is present
Nov 17 21:55:04.051 INFO running `"docker" "inspect" "37d8775b0f0d1edbdf0db315c5d4a6e7ef536bf50f8218c3ae62bccd86a65e6e"`
Nov 17 21:55:04.333 INFO running `"docker" "rm" "-f" "37d8775b0f0d1edbdf0db315c5d4a6e7ef536bf50f8218c3ae62bccd86a65e6e"`
Nov 17 21:55:04.537 INFO [stdout] 37d8775b0f0d1edbdf0db315c5d4a6e7ef536bf50f8218c3ae62bccd86a65e6e
Nov 17 21:55:04.539 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-55982/worker-5/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-5/pr-55982/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/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 +6b9b97bd9b704f85f0184f7a213cc4d62bd9654c-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 17 21:55:04.962 INFO [stdout] 26ba7b7f56432c43ffb58882170830e083b20ed9d73fb001004c32f0f597538f
Nov 17 21:55:04.965 INFO running `"docker" "start" "-a" "26ba7b7f56432c43ffb58882170830e083b20ed9d73fb001004c32f0f597538f"`
Nov 17 21:55:06.314 INFO [stderr] usermod: no changes
Nov 17 21:55:06.451 INFO [stderr]    Compiling stache v0.2.0 (/source)
Nov 17 21:55:12.249 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 5.89s
Nov 17 21:55:12.251 INFO [stderr] su: No module specific data is present
Nov 17 21:55:12.955 INFO running `"docker" "inspect" "26ba7b7f56432c43ffb58882170830e083b20ed9d73fb001004c32f0f597538f"`
Nov 17 21:55:13.155 INFO running `"docker" "rm" "-f" "26ba7b7f56432c43ffb58882170830e083b20ed9d73fb001004c32f0f597538f"`
Nov 17 21:55:13.552 INFO [stdout] 26ba7b7f56432c43ffb58882170830e083b20ed9d73fb001004c32f0f597538f
Nov 17 21:55:13.557 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-55982/worker-5/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-5/pr-55982/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/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 +6b9b97bd9b704f85f0184f7a213cc4d62bd9654c-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 17 21:55:13.941 INFO [stdout] 1ccb4b46603692ed5a73f9c658f786f6375141d1e24fd36b1d25737c96b39d90
Nov 17 21:55:13.949 INFO running `"docker" "start" "-a" "1ccb4b46603692ed5a73f9c658f786f6375141d1e24fd36b1d25737c96b39d90"`
Nov 17 21:55:15.432 INFO [stderr] usermod: no changes
Nov 17 21:55:15.515 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 0.06s
Nov 17 21:55:15.515 INFO [stderr]      Running /target/debug/deps/stache-e3c9447323146315
Nov 17 21:55:15.523 INFO [stdout] 
Nov 17 21:55:15.523 INFO [stdout] running 22 tests
Nov 17 21:55:15.526 INFO [stdout] test path::tests::to_string ... ok
Nov 17 21:55:15.536 INFO [stdout] test tests::comment ... ok
Nov 17 21:55:15.536 INFO [stdout] test tests::ampersand ... ok
Nov 17 21:55:15.559 INFO [stdout] test tests::dot ... ok
Nov 17 21:55:15.567 INFO [stdout] test tests::html ... ok
Nov 17 21:55:15.575 INFO [stdout] test tests::identifier ... ok
Nov 17 21:55:15.575 INFO [stdout] test tests::invalid_section ... ok
Nov 17 21:55:15.591 INFO [stdout] test tests::partial ... ok
Nov 17 21:55:15.591 INFO [stdout] test tests::inverted ... ok
Nov 17 21:55:15.603 INFO [stdout] test template::tests::name ... ok
Nov 17 21:55:15.603 INFO [stdout] test tests::path ... ok
Nov 17 21:55:15.611 INFO [stdout] test tests::section ... ok
Nov 17 21:55:15.623 INFO [stdout] test tests::partial_id ... ok
Nov 17 21:55:15.651 INFO [stdout] test name::tests::id ... ok
Nov 17 21:55:15.651 INFO [stdout] test tests::program ... ok
Nov 17 21:55:15.651 INFO [stdout] test tests::variable ... ok
Nov 17 21:55:15.651 INFO [stdout] test tests::whitespace ... ok
Nov 17 21:55:15.661 INFO [stdout] test tests::tree ... ok
Nov 17 21:55:15.664 INFO [stdout] test name::tests::next ... ok
Nov 17 21:55:15.711 INFO [stdout] test ruby::tests::validates_invalid_partial_reference ... ok
Nov 17 21:55:15.750 INFO [stdout] test ruby::tests::validates_valid_partial_reference ... ok
Nov 17 21:55:15.843 INFO [stdout] test ruby::tests::transforms_tree_into_functions ... ok
Nov 17 21:55:15.843 INFO [stdout] 
Nov 17 21:55:15.843 INFO [stdout] test result: ok. 22 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Nov 17 21:55:15.843 INFO [stdout] 
Nov 17 21:55:15.851 INFO [stdout] 
Nov 17 21:55:15.851 INFO [stderr]      Running /target/debug/deps/stache-f420fb6789b859d7
Nov 17 21:55:15.851 INFO [stdout] running 0 tests
Nov 17 21:55:15.851 INFO [stderr]      Running /target/debug/deps/spec-334707a936434e7d
Nov 17 21:55:15.851 INFO [stdout] 
Nov 17 21:55:15.851 INFO [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Nov 17 21:55:15.851 INFO [stdout] 
Nov 17 21:55:15.854 INFO [stdout] 
Nov 17 21:55:15.854 INFO [stdout] running 1 test
Nov 17 21:55:15.862 INFO [stdout] test ruby ... ignored
Nov 17 21:55:15.862 INFO [stderr]    Doc-tests stache
Nov 17 21:55:15.862 INFO [stdout] 
Nov 17 21:55:15.862 INFO [stdout] test result: ok. 0 passed; 0 failed; 1 ignored; 0 measured; 0 filtered out
Nov 17 21:55:15.862 INFO [stdout] 
Nov 17 21:55:17.282 INFO [stdout] 
Nov 17 21:55:17.282 INFO [stdout] running 0 tests
Nov 17 21:55:17.282 INFO [stdout] 
Nov 17 21:55:17.283 INFO [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Nov 17 21:55:17.283 INFO [stdout] 
Nov 17 21:55:17.289 INFO [stderr] su: No module specific data is present
Nov 17 21:55:18.096 INFO running `"docker" "inspect" "1ccb4b46603692ed5a73f9c658f786f6375141d1e24fd36b1d25737c96b39d90"`
Nov 17 21:55:18.377 INFO running `"docker" "rm" "-f" "1ccb4b46603692ed5a73f9c658f786f6375141d1e24fd36b1d25737c96b39d90"`
Nov 17 21:55:18.683 INFO [stdout] 1ccb4b46603692ed5a73f9c658f786f6375141d1e24fd36b1d25737c96b39d90