Dec 05 23:16:23.202 INFO testing fredrikpe/less2 against master#906deae0790bd18681b937fe9a141a3c26cf1855 for pr-56514
Dec 05 23:16:23.202 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56514/worker-4/master#906deae0790bd18681b937fe9a141a3c26cf1855:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-4/pr-56514/master#906deae0790bd18681b937fe9a141a3c26cf1855:/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 +906deae0790bd18681b937fe9a141a3c26cf1855-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"`
Dec 05 23:16:23.492 INFO [stdout] 44c6802e6abc8bcf0f46239c1b1a9429a29955ef84b1f72f4e6944f2c42b2d9e
Dec 05 23:16:23.498 INFO running `"docker" "start" "-a" "44c6802e6abc8bcf0f46239c1b1a9429a29955ef84b1f72f4e6944f2c42b2d9e"`
Dec 05 23:16:24.184 INFO [stderr] usermod: no changes
Dec 05 23:16:24.400 INFO [stderr]    Compiling termion v1.5.1
Dec 05 23:16:24.413 INFO [stderr]    Compiling encoding_rs_io v0.1.3
Dec 05 23:16:24.424 INFO [stderr]    Compiling grep-matcher v0.1.1
Dec 05 23:16:24.424 INFO [stderr]    Compiling globset v0.4.2
Dec 05 23:16:25.752 INFO [stderr]    Compiling grep-searcher v0.1.1
Dec 05 23:16:25.752 INFO [stderr]    Compiling grep-regex v0.1.1
Dec 05 23:16:28.870 INFO [stderr]    Compiling grep-cli v0.1.1
Dec 05 23:16:29.444 INFO [stderr]    Compiling grep-printer v0.1.1
Dec 05 23:16:32.652 INFO [stderr]    Compiling grep v0.2.3
Dec 05 23:16:35.226 INFO [stderr]    Compiling less2 v0.1.0 (/source)
Dec 05 23:16:37.160 INFO [stderr] warning: unused imports: `Read`, `Seek`
Dec 05 23:16:37.160 INFO [stderr]  --> src/commands.rs:2:15
Dec 05 23:16:37.160 INFO [stderr]   |
Dec 05 23:16:37.160 INFO [stderr] 2 | use std::io::{Seek, Read, Error, ErrorKind};
Dec 05 23:16:37.160 INFO [stderr]   |               ^^^^  ^^^^
Dec 05 23:16:37.160 INFO [stderr]   |
Dec 05 23:16:37.160 INFO [stderr]   = note: #[warn(unused_imports)] on by default
Dec 05 23:16:37.160 INFO [stderr] 
Dec 05 23:16:37.160 INFO [stderr] warning: unused import: `std::io`
Dec 05 23:16:37.160 INFO [stderr]  --> src/searcher.rs:3:5
Dec 05 23:16:37.160 INFO [stderr]   |
Dec 05 23:16:37.160 INFO [stderr] 3 | use std::io;
Dec 05 23:16:37.160 INFO [stderr]   |     ^^^^^^^
Dec 05 23:16:37.160 INFO [stderr] 
Dec 05 23:16:37.160 INFO [stderr] warning: unused imports: `SinkMatch`, `Sink`
Dec 05 23:16:37.160 INFO [stderr]  --> src/searcher.rs:6:32
Dec 05 23:16:37.160 INFO [stderr]   |
Dec 05 23:16:37.160 INFO [stderr] 6 | use grep::searcher::{Searcher, Sink, SinkMatch};
Dec 05 23:16:37.160 INFO [stderr]   |                                ^^^^  ^^^^^^^^^
Dec 05 23:16:37.160 INFO [stderr] 
Dec 05 23:16:37.160 INFO [stderr] warning: unused import: `unicode_segmentation::GraphemeCursor`
Dec 05 23:16:37.160 INFO [stderr]  --> src/string_util.rs:2:5
Dec 05 23:16:37.160 INFO [stderr]   |
Dec 05 23:16:37.160 INFO [stderr] 2 | use unicode_segmentation::GraphemeCursor;
Dec 05 23:16:37.160 INFO [stderr]   |     ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^
Dec 05 23:16:37.161 INFO [stderr] 
Dec 05 23:16:37.161 INFO [stderr] warning: unused import: `std::str`
Dec 05 23:16:37.161 INFO [stderr]  --> src/valid_reader.rs:3:5
Dec 05 23:16:37.161 INFO [stderr]   |
Dec 05 23:16:37.161 INFO [stderr] 3 | use std::str;
Dec 05 23:16:37.161 INFO [stderr]   |     ^^^^^^^^
Dec 05 23:16:37.161 INFO [stderr] 
Dec 05 23:16:37.161 INFO [stderr] warning: unused import: `unicode_segmentation::GraphemeCursor`
Dec 05 23:16:37.161 INFO [stderr]  --> src/valid_reader.rs:5:5
Dec 05 23:16:37.161 INFO [stderr]   |
Dec 05 23:16:37.161 INFO [stderr] 5 | use unicode_segmentation::GraphemeCursor;
Dec 05 23:16:37.161 INFO [stderr]   |     ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^
Dec 05 23:16:37.161 INFO [stderr] 
Dec 05 23:16:37.464 INFO [stderr] warning: unused variable: `e`
Dec 05 23:16:37.464 INFO [stderr]   --> src/utf8_validation.rs:15:56
Dec 05 23:16:37.464 INFO [stderr]    |
Dec 05 23:16:37.464 INFO [stderr] 15 |             Err(Utf8Error { valid_up_to: v, error_len: e }) => {
Dec 05 23:16:37.464 INFO [stderr]    |                                                        ^ help: consider using `_e` instead
Dec 05 23:16:37.464 INFO [stderr]    |
Dec 05 23:16:37.464 INFO [stderr]    = note: #[warn(unused_variables)] on by default
Dec 05 23:16:37.464 INFO [stderr] 
Dec 05 23:16:37.464 INFO [stderr] warning: unused variable: `new_pos`
Dec 05 23:16:37.464 INFO [stderr]    --> src/file_buffer.rs:120:13
Dec 05 23:16:37.464 INFO [stderr]     |
Dec 05 23:16:37.464 INFO [stderr] 120 |         let new_pos = self.seek(SeekFrom::Current(-(size as i64)))?;
Dec 05 23:16:37.464 INFO [stderr]     |             ^^^^^^^ help: consider using `_new_pos` instead
Dec 05 23:16:37.464 INFO [stderr] 
Dec 05 23:16:37.542 INFO [stderr] warning: struct is never constructed: `NormalMode`
Dec 05 23:16:37.542 INFO [stderr]    --> src/commands.rs:253:1
Dec 05 23:16:37.542 INFO [stderr]     |
Dec 05 23:16:37.542 INFO [stderr] 253 | pub struct NormalMode {
Dec 05 23:16:37.542 INFO [stderr]     | ^^^^^^^^^^^^^^^^^^^^^
Dec 05 23:16:37.543 INFO [stderr]     |
Dec 05 23:16:37.543 INFO [stderr]     = note: #[warn(dead_code)] on by default
Dec 05 23:16:37.543 INFO [stderr] 
Dec 05 23:16:37.543 INFO [stderr] warning: function is never used: `nth_grapheme_offset`
Dec 05 23:16:37.543 INFO [stderr]  --> src/string_util.rs:9:1
Dec 05 23:16:37.543 INFO [stderr]   |
Dec 05 23:16:37.543 INFO [stderr] 9 | pub fn nth_grapheme_offset(buf: &str, n: usize) -> Option<usize> {
Dec 05 23:16:37.543 INFO [stderr]   | ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^
Dec 05 23:16:37.543 INFO [stderr] 
Dec 05 23:16:37.543 INFO [stderr] warning: function is never used: `last_newline_offset`
Dec 05 23:16:37.543 INFO [stderr]   --> src/string_util.rs:37:1
Dec 05 23:16:37.543 INFO [stderr]    |
Dec 05 23:16:37.543 INFO [stderr] 37 | pub fn last_newline_offset(buf: &str) -> Option<usize> {
Dec 05 23:16:37.543 INFO [stderr]    | ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^
Dec 05 23:16:37.543 INFO [stderr] 
Dec 05 23:16:37.543 INFO [stderr] warning: function is never used: `snd_last_newline_wrapped`
Dec 05 23:16:37.543 INFO [stderr]   --> src/string_util.rs:67:1
Dec 05 23:16:37.543 INFO [stderr]    |
Dec 05 23:16:37.543 INFO [stderr] 67 | pub fn snd_last_newline_wrapped(buf: &str, screen_width: usize) -> usize {
Dec 05 23:16:37.543 INFO [stderr]    | ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^
Dec 05 23:16:37.543 INFO [stderr] 
Dec 05 23:16:37.543 INFO [stderr] warning: function is never used: `utf8_char_width`
Dec 05 23:16:37.543 INFO [stderr]    --> src/utf8_validation.rs:190:1
Dec 05 23:16:37.543 INFO [stderr]     |
Dec 05 23:16:37.543 INFO [stderr] 190 | pub fn utf8_char_width(b: u8) -> usize {
Dec 05 23:16:37.543 INFO [stderr]     | ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^
Dec 05 23:16:37.543 INFO [stderr] 
Dec 05 23:16:41.156 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 16.95s
Dec 05 23:16:41.165 INFO [stderr] su: No module specific data is present
Dec 05 23:16:41.743 INFO running `"docker" "inspect" "44c6802e6abc8bcf0f46239c1b1a9429a29955ef84b1f72f4e6944f2c42b2d9e"`
Dec 05 23:16:41.856 INFO running `"docker" "rm" "-f" "44c6802e6abc8bcf0f46239c1b1a9429a29955ef84b1f72f4e6944f2c42b2d9e"`
Dec 05 23:16:42.052 INFO [stdout] 44c6802e6abc8bcf0f46239c1b1a9429a29955ef84b1f72f4e6944f2c42b2d9e
Dec 05 23:16:42.058 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56514/worker-4/master#906deae0790bd18681b937fe9a141a3c26cf1855:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-4/pr-56514/master#906deae0790bd18681b937fe9a141a3c26cf1855:/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 +906deae0790bd18681b937fe9a141a3c26cf1855-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"`
Dec 05 23:16:42.285 INFO [stdout] 5f34dd77b07b42e0c8896ef9c7419e0d01276d6bf0cf76bfdc45caf92a0db192
Dec 05 23:16:42.286 INFO running `"docker" "start" "-a" "5f34dd77b07b42e0c8896ef9c7419e0d01276d6bf0cf76bfdc45caf92a0db192"`
Dec 05 23:16:42.672 INFO [stderr] usermod: no changes
Dec 05 23:16:42.772 INFO [stderr]    Compiling less2 v0.1.0 (/source)
Dec 05 23:16:44.212 INFO [stderr] warning: unused imports: `Read`, `Seek`
Dec 05 23:16:44.213 INFO [stderr]  --> src/commands.rs:2:15
Dec 05 23:16:44.213 INFO [stderr]   |
Dec 05 23:16:44.213 INFO [stderr] 2 | use std::io::{Seek, Read, Error, ErrorKind};
Dec 05 23:16:44.213 INFO [stderr]   |               ^^^^  ^^^^
Dec 05 23:16:44.213 INFO [stderr]   |
Dec 05 23:16:44.213 INFO [stderr]   = note: #[warn(unused_imports)] on by default
Dec 05 23:16:44.213 INFO [stderr] 
Dec 05 23:16:44.213 INFO [stderr] warning: unused import: `std::io`
Dec 05 23:16:44.213 INFO [stderr]  --> src/searcher.rs:3:5
Dec 05 23:16:44.213 INFO [stderr]   |
Dec 05 23:16:44.213 INFO [stderr] 3 | use std::io;
Dec 05 23:16:44.213 INFO [stderr]   |     ^^^^^^^
Dec 05 23:16:44.213 INFO [stderr] 
Dec 05 23:16:44.213 INFO [stderr] warning: unused imports: `SinkMatch`, `Sink`
Dec 05 23:16:44.213 INFO [stderr]  --> src/searcher.rs:6:32
Dec 05 23:16:44.213 INFO [stderr]   |
Dec 05 23:16:44.213 INFO [stderr] 6 | use grep::searcher::{Searcher, Sink, SinkMatch};
Dec 05 23:16:44.213 INFO [stderr]   |                                ^^^^  ^^^^^^^^^
Dec 05 23:16:44.213 INFO [stderr] 
Dec 05 23:16:44.213 INFO [stderr] warning: unused import: `unicode_segmentation::GraphemeCursor`
Dec 05 23:16:44.213 INFO [stderr]  --> src/string_util.rs:2:5
Dec 05 23:16:44.213 INFO [stderr]   |
Dec 05 23:16:44.213 INFO [stderr] 2 | use unicode_segmentation::GraphemeCursor;
Dec 05 23:16:44.213 INFO [stderr]   |     ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^
Dec 05 23:16:44.213 INFO [stderr] 
Dec 05 23:16:44.213 INFO [stderr] warning: unused import: `std::str`
Dec 05 23:16:44.213 INFO [stderr]  --> src/valid_reader.rs:3:5
Dec 05 23:16:44.213 INFO [stderr]   |
Dec 05 23:16:44.213 INFO [stderr] 3 | use std::str;
Dec 05 23:16:44.213 INFO [stderr]   |     ^^^^^^^^
Dec 05 23:16:44.213 INFO [stderr] 
Dec 05 23:16:44.213 INFO [stderr] warning: unused import: `unicode_segmentation::GraphemeCursor`
Dec 05 23:16:44.213 INFO [stderr]  --> src/valid_reader.rs:5:5
Dec 05 23:16:44.213 INFO [stderr]   |
Dec 05 23:16:44.213 INFO [stderr] 5 | use unicode_segmentation::GraphemeCursor;
Dec 05 23:16:44.213 INFO [stderr]   |     ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^
Dec 05 23:16:44.213 INFO [stderr] 
Dec 05 23:16:44.591 INFO [stderr] warning: unused variable: `e`
Dec 05 23:16:44.591 INFO [stderr]   --> src/utf8_validation.rs:15:56
Dec 05 23:16:44.591 INFO [stderr]    |
Dec 05 23:16:44.591 INFO [stderr] 15 |             Err(Utf8Error { valid_up_to: v, error_len: e }) => {
Dec 05 23:16:44.591 INFO [stderr]    |                                                        ^ help: consider using `_e` instead
Dec 05 23:16:44.591 INFO [stderr]    |
Dec 05 23:16:44.591 INFO [stderr]    = note: #[warn(unused_variables)] on by default
Dec 05 23:16:44.591 INFO [stderr] 
Dec 05 23:16:44.592 INFO [stderr] warning: unused variable: `new_pos`
Dec 05 23:16:44.592 INFO [stderr]    --> src/file_buffer.rs:120:13
Dec 05 23:16:44.592 INFO [stderr]     |
Dec 05 23:16:44.592 INFO [stderr] 120 |         let new_pos = self.seek(SeekFrom::Current(-(size as i64)))?;
Dec 05 23:16:44.592 INFO [stderr]     |             ^^^^^^^ help: consider using `_new_pos` instead
Dec 05 23:16:44.592 INFO [stderr] 
Dec 05 23:16:44.725 INFO [stderr] warning: struct is never constructed: `NormalMode`
Dec 05 23:16:44.725 INFO [stderr]    --> src/commands.rs:253:1
Dec 05 23:16:44.725 INFO [stderr]     |
Dec 05 23:16:44.726 INFO [stderr] 253 | pub struct NormalMode {
Dec 05 23:16:44.726 INFO [stderr]     | ^^^^^^^^^^^^^^^^^^^^^
Dec 05 23:16:44.726 INFO [stderr]     |
Dec 05 23:16:44.726 INFO [stderr]     = note: #[warn(dead_code)] on by default
Dec 05 23:16:44.726 INFO [stderr] 
Dec 05 23:16:44.726 INFO [stderr] warning: function is never used: `utf8_char_width`
Dec 05 23:16:44.726 INFO [stderr]    --> src/utf8_validation.rs:190:1
Dec 05 23:16:44.726 INFO [stderr]     |
Dec 05 23:16:44.726 INFO [stderr] 190 | pub fn utf8_char_width(b: u8) -> usize {
Dec 05 23:16:44.726 INFO [stderr]     | ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^
Dec 05 23:16:44.726 INFO [stderr] 
Dec 05 23:16:46.427 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 3.73s
Dec 05 23:16:46.437 INFO [stderr] su: No module specific data is present
Dec 05 23:16:46.956 INFO running `"docker" "inspect" "5f34dd77b07b42e0c8896ef9c7419e0d01276d6bf0cf76bfdc45caf92a0db192"`
Dec 05 23:16:47.222 INFO running `"docker" "rm" "-f" "5f34dd77b07b42e0c8896ef9c7419e0d01276d6bf0cf76bfdc45caf92a0db192"`
Dec 05 23:16:47.471 INFO [stdout] 5f34dd77b07b42e0c8896ef9c7419e0d01276d6bf0cf76bfdc45caf92a0db192
Dec 05 23:16:47.476 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56514/worker-4/master#906deae0790bd18681b937fe9a141a3c26cf1855:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-4/pr-56514/master#906deae0790bd18681b937fe9a141a3c26cf1855:/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 +906deae0790bd18681b937fe9a141a3c26cf1855-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"`
Dec 05 23:16:47.975 INFO [stdout] 95459ae494145a727e72c7b759abbbeae1d4cbe0601ff0dea6a74ee5b98d1734
Dec 05 23:16:47.978 INFO running `"docker" "start" "-a" "95459ae494145a727e72c7b759abbbeae1d4cbe0601ff0dea6a74ee5b98d1734"`
Dec 05 23:16:49.247 INFO [stderr] usermod: no changes
Dec 05 23:16:49.351 INFO [stderr]     Finished dev [unoptimized + debuginfo] target(s) in 0.08s
Dec 05 23:16:49.365 INFO [stderr]      Running /target/debug/deps/less2-674ef90e1cdb81d3
Dec 05 23:16:49.367 INFO [stdout] 
Dec 05 23:16:49.367 INFO [stdout] running 14 tests
Dec 05 23:16:49.368 INFO [stdout] test string_util::tests::byte_offset_strange ... ok
Dec 05 23:16:49.368 INFO [stdout] test string_util::tests::test_last_newline_offset ... ok
Dec 05 23:16:49.368 INFO [stdout] test string_util::tests::test_nth_newline_wrapped ... ok
Dec 05 23:16:49.369 INFO [stdout] test string_util::tests::byte_offset_simple ... ok
Dec 05 23:16:49.369 INFO [stdout] test string_util::tests::test_snd_last_newline_wrapped ... ok
Dec 05 23:16:49.369 INFO [stdout] test valid_reader::tests::test_seek_to_end ... ok
Dec 05 23:16:49.369 INFO [stdout] test valid_reader::tests::test_err_at_end ... ok
Dec 05 23:16:49.369 INFO [stdout] test valid_reader::tests::test_bufreader_fails_end ... ok
Dec 05 23:16:49.369 INFO [stdout] test utf8_validation::tests::test_utf8_validation ... ok
Dec 05 23:16:49.372 INFO [stdout] test valid_reader::tests::test_seek_0_returns_0 ... ok
Dec 05 23:16:49.372 INFO [stdout] test utf8_validation::tests::test_first_valid_pos ... ok
Dec 05 23:16:49.373 INFO [stdout] test valid_reader::tests::test_valid_from_1 ... ok
Dec 05 23:16:49.376 INFO [stdout] test valid_reader::tests::test_bufreader_fails_start ... ok
Dec 05 23:16:49.433 INFO [stdout] test string_util::tests::test_nth_last_newline_wrapped ... ok
Dec 05 23:16:49.433 INFO [stdout] 
Dec 05 23:16:49.433 INFO [stdout] test result: ok. 14 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out
Dec 05 23:16:49.433 INFO [stdout] 
Dec 05 23:16:49.440 INFO [stderr] su: No module specific data is present
Dec 05 23:16:49.722 INFO running `"docker" "inspect" "95459ae494145a727e72c7b759abbbeae1d4cbe0601ff0dea6a74ee5b98d1734"`
Dec 05 23:16:49.802 INFO running `"docker" "rm" "-f" "95459ae494145a727e72c7b759abbbeae1d4cbe0601ff0dea6a74ee5b98d1734"`
Dec 05 23:16:49.907 INFO [stdout] 95459ae494145a727e72c7b759abbbeae1d4cbe0601ff0dea6a74ee5b98d1734