Nov 17 11:39:03.505 INFO testing SuperTanker/ruplacer against master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c for pr-55982 Nov 17 11:39:03.505 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-55982/worker-0/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-0/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 11:39:04.072 INFO [stdout] 06eb2b81198924daca89154beeeae5adcf75f29c65673e8dae38d2f0eee5e297 Nov 17 11:39:04.079 INFO running `"docker" "start" "-a" "06eb2b81198924daca89154beeeae5adcf75f29c65673e8dae38d2f0eee5e297"` Nov 17 11:39:05.003 INFO [stderr] usermod: no changes Nov 17 11:39:05.215 INFO [stderr] Compiling crossbeam-epoch v0.6.0 Nov 17 11:39:05.215 INFO [stderr] Compiling syn v0.15.9 Nov 17 11:39:05.223 INFO [stderr] Compiling globset v0.4.2 Nov 17 11:39:05.224 INFO [stderr] Compiling Inflector v0.11.3 Nov 17 11:39:09.676 INFO [stderr] Compiling crossbeam-channel v0.2.6 Nov 17 11:39:14.988 INFO [stderr] Compiling ignore v0.4.4 Nov 17 11:39:25.831 INFO [stderr] Compiling structopt-derive v0.2.11 Nov 17 11:39:29.991 INFO [stderr] Compiling structopt v0.2.11 Nov 17 11:39:30.447 INFO [stderr] Compiling ruplacer v0.2.5 (/source) Nov 17 11:39:35.411 INFO [stderr] Finished dev [unoptimized + debuginfo] target(s) in 30.38s Nov 17 11:39:35.425 INFO [stderr] su: No module specific data is present Nov 17 11:39:36.117 INFO running `"docker" "inspect" "06eb2b81198924daca89154beeeae5adcf75f29c65673e8dae38d2f0eee5e297"` Nov 17 11:39:36.310 INFO running `"docker" "rm" "-f" "06eb2b81198924daca89154beeeae5adcf75f29c65673e8dae38d2f0eee5e297"` Nov 17 11:39:36.442 INFO [stdout] 06eb2b81198924daca89154beeeae5adcf75f29c65673e8dae38d2f0eee5e297 Nov 17 11:39:36.445 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-55982/worker-0/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-0/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 11:39:36.621 INFO [stdout] 42173f22a613f02b6854d9529063efe994cb138b5a777369cfa36be979028b13 Nov 17 11:39:36.623 INFO running `"docker" "start" "-a" "42173f22a613f02b6854d9529063efe994cb138b5a777369cfa36be979028b13"` Nov 17 11:39:37.055 INFO [stderr] usermod: no changes Nov 17 11:39:37.162 INFO [stderr] Compiling ruplacer v0.2.5 (/source) Nov 17 11:39:40.885 INFO [stderr] Finished dev [unoptimized + debuginfo] target(s) in 3.81s Nov 17 11:39:40.905 INFO [stderr] su: No module specific data is present Nov 17 11:39:41.890 INFO running `"docker" "inspect" "42173f22a613f02b6854d9529063efe994cb138b5a777369cfa36be979028b13"` Nov 17 11:39:42.189 INFO running `"docker" "rm" "-f" "42173f22a613f02b6854d9529063efe994cb138b5a777369cfa36be979028b13"` Nov 17 11:39:42.535 INFO [stdout] 42173f22a613f02b6854d9529063efe994cb138b5a777369cfa36be979028b13 Nov 17 11:39:42.537 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-55982/worker-0/master#6b9b97bd9b704f85f0184f7a213cc4d62bd9654c:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-0/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 11:39:43.000 INFO [stdout] e1327fbf57c12941d6cb53f6e5ccc2a6d9f9dd3b2b29dba1465910105da03de2 Nov 17 11:39:43.001 INFO running `"docker" "start" "-a" "e1327fbf57c12941d6cb53f6e5ccc2a6d9f9dd3b2b29dba1465910105da03de2"` Nov 17 11:39:44.214 INFO [stderr] usermod: no changes Nov 17 11:39:44.354 INFO [stderr] Finished dev [unoptimized + debuginfo] target(s) in 0.10s Nov 17 11:39:44.360 INFO [stderr] Running /target/debug/deps/ruplacer-d19c8c2f221652c9 Nov 17 11:39:44.367 INFO [stdout] Nov 17 11:39:44.367 INFO [stdout] running 8 tests Nov 17 11:39:44.380 INFO [stdout] test line_patcher::tests::test_subvert_inconsistent ... ok Nov 17 11:39:44.380 INFO [stdout] test file_patcher::tests::test_replacement_display ... ok Nov 17 11:39:44.380 INFO [stdout] test line_patcher::tests::test_substring ... ok Nov 17 11:39:44.380 INFO [stdout] test line_patcher::tests::test_subvert_happy ... ok Nov 17 11:39:44.380 INFO [stdout] test file_patcher::tests::test_compute_replacements ... ok Nov 17 11:39:44.427 INFO [stdout] test file_patcher::tests::test_patch_file ... ok Nov 17 11:39:44.515 INFO [stdout] test line_patcher::tests::test_regex ... ok Nov 17 11:39:44.743 INFO [stdout] test stats::tests::test_stats_to_string ... ok Nov 17 11:39:44.743 INFO [stdout] Nov 17 11:39:44.743 INFO [stdout] test result: ok. 8 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out Nov 17 11:39:44.743 INFO [stdout] Nov 17 11:39:44.750 INFO [stdout] Nov 17 11:39:44.750 INFO [stdout] running 0 tests Nov 17 11:39:44.750 INFO [stdout] Nov 17 11:39:44.750 INFO [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out Nov 17 11:39:44.750 INFO [stdout] Nov 17 11:39:44.750 INFO [stderr] Running /target/debug/deps/ruplacer-9f2b5221233cfdce Nov 17 11:39:44.750 INFO [stderr] Running /target/debug/deps/integration_tests-0746cc44801f6642 Nov 17 11:39:44.751 INFO [stdout] Nov 17 11:39:44.751 INFO [stdout] running 5 tests Nov 17 11:39:44.763 INFO [stdout] test test_skip_non_utf8_files ... ok Nov 17 11:39:44.763 INFO [stdout] test test_stats ... ok Nov 17 11:39:44.767 INFO [stdout] test test_replace_old_by_new ... ok Nov 17 11:39:44.767 INFO [stdout] test test_dry_run ... ok Nov 17 11:39:44.833 INFO [stdout] test test_with_gitignore ... FAILED Nov 17 11:39:44.833 INFO [stdout] Nov 17 11:39:44.833 INFO [stdout] failures: Nov 17 11:39:44.833 INFO [stdout] Nov 17 11:39:44.833 INFO [stdout] ---- test_with_gitignore stdout ---- Nov 17 11:39:44.833 INFO [stdout] Patching /tmp/test-ruplacer.Vj73t2HG6zK2/data/top.txt Nov 17 11:39:44.833 INFO [stdout] -- Top: old is nice Nov 17 11:39:44.833 INFO [stdout] ++ Top: new is nice Nov 17 11:39:44.833 INFO [stdout] Nov 17 11:39:44.833 INFO [stdout] Patching /tmp/test-ruplacer.Vj73t2HG6zK2/data/a_dir/sub/foo.txt Nov 17 11:39:44.833 INFO [stdout] -- sub/foo: old is everywhere, old is old Nov 17 11:39:44.833 INFO [stdout] ++ sub/foo: new is everywhere, new is new Nov 17 11:39:44.833 INFO [stdout] -- old is really old Nov 17 11:39:44.833 INFO [stdout] ++ new is really new Nov 17 11:39:44.833 INFO [stdout] Nov 17 11:39:44.833 INFO [stdout] thread 'test_with_gitignore' panicked at 'Could not read from "/tmp/test-ruplacer.Vj73t2HG6zK2/data/.hidden/hidden.txt": Os { code: 2, kind: NotFound, message: "No such file or directory" }', libcore/result.rs:1009:5 Nov 17 11:39:44.833 INFO [stdout] stack backtrace: Nov 17 11:39:44.833 INFO [stdout] 0: 0x55b781f419b3 - std::sys::unix::backtrace::tracing::imp::unwind_backtrace::h1a944b80a560daa8 Nov 17 11:39:44.833 INFO [stdout] at libstd/sys/unix/backtrace/tracing/gcc_s.rs:49 Nov 17 11:39:44.833 INFO [stdout] 1: 0x55b781f3c068 - std::sys_common::backtrace::_print::h18f735b4c3a49bdb Nov 17 11:39:44.833 INFO [stdout] at libstd/sys_common/backtrace.rs:71 Nov 17 11:39:44.833 INFO [stdout] 2: 0x55b781f408b4 - std::panicking::default_hook::{{closure}}::h97ab3548a215c097 Nov 17 11:39:44.833 INFO [stdout] at libstd/sys_common/backtrace.rs:59 Nov 17 11:39:44.833 INFO [stdout] at libstd/panicking.rs:211 Nov 17 11:39:44.833 INFO [stdout] 3: 0x55b781f4059c - std::panicking::default_hook::h98c2a01ef734e4b0 Nov 17 11:39:44.833 INFO [stdout] at libstd/panicking.rs:221 Nov 17 11:39:44.833 INFO [stdout] 4: 0x55b781f40fc0 - std::panicking::rust_panic_with_hook::hb4b3f28eb79ea752 Nov 17 11:39:44.833 INFO [stdout] at libstd/panicking.rs:476 Nov 17 11:39:44.833 INFO [stdout] 5: 0x55b781f40b41 - std::panicking::continue_panic_fmt::h61fd5a7b1a268752 Nov 17 11:39:44.833 INFO [stdout] at libstd/panicking.rs:390 Nov 17 11:39:44.833 INFO [stdout] 6: 0x55b781f40a25 - rust_begin_unwind Nov 17 11:39:44.833 INFO [stdout] at libstd/panicking.rs:325 Nov 17 11:39:44.833 INFO [stdout] 7: 0x55b781f5693c - core::panicking::panic_fmt::h400423a63e8ecedb Nov 17 11:39:44.833 INFO [stdout] at libcore/panicking.rs:77 Nov 17 11:39:44.833 INFO [stdout] 8: 0x55b781c42400 - core::result::unwrap_failed::h59d5c27292c0a6b8 Nov 17 11:39:44.833 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libcore/macros.rs:26 Nov 17 11:39:44.833 INFO [stdout] 9: 0x55b781bf4327 - >::expect::h741356ed7d6555fe Nov 17 11:39:44.833 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libcore/result.rs:835 Nov 17 11:39:44.833 INFO [stdout] 10: 0x55b781bedeba - integration_tests::assert_not_replaced::h122f8fa77b4ae9f5 Nov 17 11:39:44.833 INFO [stdout] at tests/integration_tests.rs:28 Nov 17 11:39:44.833 INFO [stdout] 11: 0x55b781beedba - integration_tests::test_with_gitignore::hd7e01b83e7d07132 Nov 17 11:39:44.833 INFO [stdout] at tests/integration_tests.rs:92 Nov 17 11:39:44.833 INFO [stdout] 12: 0x55b781beebe9 - integration_tests::test_with_gitignore::{{closure}}::h55833ce99ff74698 Nov 17 11:39:44.833 INFO [stdout] at tests/integration_tests.rs:82 Nov 17 11:39:44.833 INFO [stdout] 13: 0x55b781bf040d - core::ops::function::FnOnce::call_once::he7303ebacc408d2a Nov 17 11:39:44.833 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libcore/ops/function.rs:238 Nov 17 11:39:44.833 INFO [stdout] 14: 0x55b781bfd26e - >::call_box::h9dcb7fc9b8bb4240 Nov 17 11:39:44.833 INFO [stdout] at libtest/lib.rs:1471 Nov 17 11:39:44.833 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libcore/ops/function.rs:238 Nov 17 11:39:44.833 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/liballoc/boxed.rs:673 Nov 17 11:39:44.833 INFO [stdout] 15: 0x55b781f54df9 - __rust_maybe_catch_panic Nov 17 11:39:44.833 INFO [stdout] at libpanic_unwind/lib.rs:102 Nov 17 11:39:44.833 INFO [stdout] 16: 0x55b781bf52d3 - std::sys_common::backtrace::__rust_begin_short_backtrace::h89ea8afe71e36f86 Nov 17 11:39:44.833 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/panicking.rs:289 Nov 17 11:39:44.833 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/panic.rs:398 Nov 17 11:39:44.833 INFO [stdout] at libtest/lib.rs:1426 Nov 17 11:39:44.833 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/sys_common/backtrace.rs:136 Nov 17 11:39:44.833 INFO [stdout] 17: 0x55b781bf6184 - std::panicking::try::do_call::h4132042e0cbea3ae Nov 17 11:39:44.833 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/thread/mod.rs:477 Nov 17 11:39:44.833 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/panic.rs:319 Nov 17 11:39:44.834 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/panicking.rs:310 Nov 17 11:39:44.834 INFO [stdout] 18: 0x55b781f54df9 - __rust_maybe_catch_panic Nov 17 11:39:44.834 INFO [stdout] at libpanic_unwind/lib.rs:102 Nov 17 11:39:44.834 INFO [stdout] 19: 0x55b781bfd39c - >::call_box::hab7f616f05880bf6 Nov 17 11:39:44.834 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/panicking.rs:289 Nov 17 11:39:44.834 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/panic.rs:398 Nov 17 11:39:44.834 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/libstd/thread/mod.rs:476 Nov 17 11:39:44.834 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/liballoc/boxed.rs:673 Nov 17 11:39:44.834 INFO [stdout] 20: 0x55b781f488ed - std::sys::unix::thread::Thread::new::thread_start::h5f8d67158a1ca038 Nov 17 11:39:44.834 INFO [stdout] at /rustc/6b9b97bd9b704f85f0184f7a213cc4d62bd9654c/src/liballoc/boxed.rs:683 Nov 17 11:39:44.834 INFO [stdout] at libstd/sys_common/thread.rs:24 Nov 17 11:39:44.834 INFO [stdout] at libstd/sys/unix/thread.rs:90 Nov 17 11:39:44.834 INFO [stdout] 21: 0x7f60d47ba6b9 - start_thread Nov 17 11:39:44.834 INFO [stdout] 22: 0x7f60d42da41c - clone Nov 17 11:39:44.834 INFO [stdout] 23: 0x0 - Nov 17 11:39:44.834 INFO [stdout] Nov 17 11:39:44.834 INFO [stdout] Nov 17 11:39:44.834 INFO [stdout] failures: Nov 17 11:39:44.834 INFO [stdout] test_with_gitignore Nov 17 11:39:44.834 INFO [stdout] Nov 17 11:39:44.834 INFO [stdout] test result: FAILED. 4 passed; 1 failed; 0 ignored; 0 measured; 0 filtered out Nov 17 11:39:44.834 INFO [stdout] Nov 17 11:39:44.836 INFO [stderr] error: test failed, to rerun pass '--test integration_tests' Nov 17 11:39:44.843 INFO [stderr] su: No module specific data is present Nov 17 11:39:45.309 INFO running `"docker" "inspect" "e1327fbf57c12941d6cb53f6e5ccc2a6d9f9dd3b2b29dba1465910105da03de2"` Nov 17 11:39:45.643 INFO running `"docker" "rm" "-f" "e1327fbf57c12941d6cb53f6e5ccc2a6d9f9dd3b2b29dba1465910105da03de2"` Nov 17 11:39:46.094 INFO [stdout] e1327fbf57c12941d6cb53f6e5ccc2a6d9f9dd3b2b29dba1465910105da03de2