[INFO] fetching crate gitwatch-rs 0.1.1... [INFO] testing gitwatch-rs-0.1.1 against master#e9385f9eea0221ef295a188d49d16f8f5189abf1 for pr-146098 [INFO] extracting crate gitwatch-rs 0.1.1 into /workspace/builds/worker-3-tc1/source [INFO] removed /workspace/builds/worker-3-tc1/source/.cargo/config.toml [INFO] removed /workspace/builds/worker-3-tc1/source/rust-toolchain.toml [INFO] started tweaking crates.io crate gitwatch-rs 0.1.1 [INFO] removed 0 missing tests [INFO] finished tweaking crates.io crate gitwatch-rs 0.1.1 [INFO] tweaked toml for crates.io crate gitwatch-rs 0.1.1 written to /workspace/builds/worker-3-tc1/source/Cargo.toml [INFO] validating manifest of crates.io crate gitwatch-rs 0.1.1 on toolchain e9385f9eea0221ef295a188d49d16f8f5189abf1 [INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+e9385f9eea0221ef295a188d49d16f8f5189abf1" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }` [INFO] crate crates.io crate gitwatch-rs 0.1.1 already has a lockfile, it will not be regenerated [INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+e9385f9eea0221ef295a188d49d16f8f5189abf1" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] [stderr] Updating crates.io index [INFO] [stderr] Downloading crates ... [INFO] [stderr] Downloaded shellexpand v3.1.1 [INFO] [stderr] Downloaded testresult v0.4.1 [INFO] [stderr] Downloaded terminal-prompt v0.2.3 [INFO] [stderr] Downloaded auth-git2 v0.5.8 [INFO] [stderr] Downloaded paris v1.5.15 [INFO] [stderr] Downloaded clap_complete v4.5.55 [INFO] [stderr] Downloaded file-id v0.2.2 [INFO] [stderr] Downloaded notify-debouncer-full v0.5.0 [INFO] [stderr] Downloaded fern v0.7.1 [INFO] [stderr] Downloaded libssh2-sys v0.3.1 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/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:e90291280db7d1fac5b66fc6dad9f9662629e7365a55743daf9bdf73ebc4ea79" "/opt/rustwide/cargo-home/bin/cargo" "+e9385f9eea0221ef295a188d49d16f8f5189abf1" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }` [INFO] [stdout] 17b74b07fda26164ae334113de5a260b26e65558a50e1a5893692db25760380d [INFO] running `Command { std: "docker" "start" "-a" "17b74b07fda26164ae334113de5a260b26e65558a50e1a5893692db25760380d", kill_on_drop: false }` [INFO] running `Command { std: "docker" "inspect" "17b74b07fda26164ae334113de5a260b26e65558a50e1a5893692db25760380d", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "17b74b07fda26164ae334113de5a260b26e65558a50e1a5893692db25760380d", kill_on_drop: false }` [INFO] [stdout] 17b74b07fda26164ae334113de5a260b26e65558a50e1a5893692db25760380d [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/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" "RUSTDOCFLAGS=--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:e90291280db7d1fac5b66fc6dad9f9662629e7365a55743daf9bdf73ebc4ea79" "/opt/rustwide/cargo-home/bin/cargo" "+e9385f9eea0221ef295a188d49d16f8f5189abf1" "build" "--frozen" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 9cb0b9c188d0a36f0b5187a7ccaf3838d625f25f25e7cc428fd718631beafef7 [INFO] running `Command { std: "docker" "start" "-a" "9cb0b9c188d0a36f0b5187a7ccaf3838d625f25f25e7cc428fd718631beafef7", kill_on_drop: false }` [INFO] [stderr] Compiling aho-corasick v1.1.3 [INFO] [stderr] Compiling bitflags v2.9.1 [INFO] [stderr] Compiling anstyle-query v1.1.3 [INFO] [stderr] Compiling yansi v1.0.1 [INFO] [stderr] Compiling syn v2.0.104 [INFO] [stderr] Compiling jobserver v0.1.33 [INFO] [stderr] Compiling inotify-sys v0.1.5 [INFO] [stderr] Compiling dirs-sys v0.5.0 [INFO] [stderr] Compiling uncased v0.9.10 [INFO] [stderr] Compiling mio v1.0.4 [INFO] [stderr] Compiling bstr v1.12.0 [INFO] [stderr] Compiling figment v0.10.19 [INFO] [stderr] Compiling notify-types v2.0.0 [INFO] [stderr] Compiling inlinable_string v0.1.15 [INFO] [stderr] Compiling terminal-prompt v0.2.3 [INFO] [stderr] Compiling file-id v0.2.2 [INFO] [stderr] Compiling anstream v0.6.19 [INFO] [stderr] Compiling dirs v6.0.0 [INFO] [stderr] Compiling fern v0.7.1 [INFO] [stderr] Compiling indoc v2.0.6 [INFO] [stderr] Compiling shellexpand v3.1.1 [INFO] [stderr] Compiling inotify v0.11.0 [INFO] [stderr] Compiling cc v1.2.29 [INFO] [stderr] Compiling paris v1.5.15 [INFO] [stderr] Compiling clap_builder v4.5.42 [INFO] [stderr] Compiling notify v8.1.0 [INFO] [stderr] Compiling notify-debouncer-full v0.5.0 [INFO] [stderr] Compiling regex-automata v0.4.9 [INFO] [stderr] Compiling openssl-sys v0.9.109 [INFO] [stderr] Compiling libz-sys v1.1.22 [INFO] [stderr] Compiling libssh2-sys v0.3.1 [INFO] [stderr] Compiling libgit2-sys v0.18.2+1.9.1 [INFO] [stderr] Compiling synstructure v0.13.2 [INFO] [stderr] Compiling proc-macro2-diagnostics v0.10.1 [INFO] [stderr] Compiling globset v0.4.16 [INFO] [stderr] Compiling regex v1.11.1 [INFO] [stderr] Compiling zerofrom-derive v0.1.6 [INFO] [stderr] Compiling yoke-derive v0.8.0 [INFO] [stderr] Compiling zerovec-derive v0.11.1 [INFO] [stderr] Compiling displaydoc v0.2.5 [INFO] [stderr] Compiling serde_derive v1.0.219 [INFO] [stderr] Compiling pear_codegen v0.2.9 [INFO] [stderr] Compiling clap_derive v4.5.41 [INFO] [stderr] Compiling ignore v0.4.23 [INFO] [stderr] Compiling pear v0.2.9 [INFO] [stderr] Compiling zerofrom v0.1.6 [INFO] [stderr] Compiling yoke v0.8.0 [INFO] [stderr] Compiling zerotrie v0.2.2 [INFO] [stderr] Compiling clap v4.5.42 [INFO] [stderr] Compiling zerovec v0.11.2 [INFO] [stderr] Compiling clap_complete v4.5.55 [INFO] [stderr] Compiling tinystr v0.8.1 [INFO] [stderr] Compiling potential_utf v0.1.2 [INFO] [stderr] Compiling icu_collections v2.0.0 [INFO] [stderr] Compiling icu_locale_core v2.0.0 [INFO] [stderr] Compiling serde v1.0.219 [INFO] [stderr] Compiling icu_provider v2.0.0 [INFO] [stderr] Compiling icu_normalizer v2.0.0 [INFO] [stderr] Compiling icu_properties v2.0.1 [INFO] [stderr] Compiling idna_adapter v1.2.1 [INFO] [stderr] Compiling idna v1.0.3 [INFO] [stderr] Compiling url v2.5.4 [INFO] [stderr] Compiling serde_yaml v0.9.34+deprecated [INFO] [stderr] Compiling serde_regex v1.1.0 [INFO] [stderr] Compiling git2 v0.20.2 [INFO] [stderr] Compiling auth-git2 v0.5.8 [INFO] [stderr] Compiling gitwatch-rs v0.1.1 (/opt/rustwide/workdir) [INFO] [stderr] Finished `dev` profile [unoptimized + debuginfo] target(s) in 56.80s [INFO] running `Command { std: "docker" "inspect" "9cb0b9c188d0a36f0b5187a7ccaf3838d625f25f25e7cc428fd718631beafef7", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "9cb0b9c188d0a36f0b5187a7ccaf3838d625f25f25e7cc428fd718631beafef7", kill_on_drop: false }` [INFO] [stdout] 9cb0b9c188d0a36f0b5187a7ccaf3838d625f25f25e7cc428fd718631beafef7 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/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" "RUSTDOCFLAGS=--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:e90291280db7d1fac5b66fc6dad9f9662629e7365a55743daf9bdf73ebc4ea79" "/opt/rustwide/cargo-home/bin/cargo" "+e9385f9eea0221ef295a188d49d16f8f5189abf1" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 2bda02fd65d438745599e1e53d43d57238b7a4f040811777662b5c3d0383d6d9 [INFO] running `Command { std: "docker" "start" "-a" "2bda02fd65d438745599e1e53d43d57238b7a4f040811777662b5c3d0383d6d9", kill_on_drop: false }` [INFO] [stderr] Compiling regex-automata v0.4.9 [INFO] [stderr] Compiling num-traits v0.2.19 [INFO] [stderr] Compiling inotify v0.11.0 [INFO] [stderr] Compiling getrandom v0.3.3 [INFO] [stderr] Compiling wait-timeout v0.2.1 [INFO] [stderr] Compiling testresult v0.4.1 [INFO] [stderr] Compiling git2 v0.20.2 [INFO] [stderr] Compiling rand_core v0.9.3 [INFO] [stderr] Compiling tempfile v3.20.0 [INFO] [stderr] Compiling notify v8.1.0 [INFO] [stderr] Compiling rand_chacha v0.9.0 [INFO] [stderr] Compiling rand v0.9.2 [INFO] [stderr] Compiling notify-debouncer-full v0.5.0 [INFO] [stderr] Compiling float-cmp v0.10.0 [INFO] [stderr] Compiling regex v1.11.1 [INFO] [stderr] Compiling bstr v1.12.0 [INFO] [stderr] Compiling serde_regex v1.1.0 [INFO] [stderr] Compiling predicates v3.1.3 [INFO] [stderr] Compiling auth-git2 v0.5.8 [INFO] [stderr] Compiling globset v0.4.16 [INFO] [stderr] Compiling ignore v0.4.23 [INFO] [stderr] Compiling assert_cmd v2.0.17 [INFO] [stderr] Compiling gitwatch-rs v0.1.1 (/opt/rustwide/workdir) [INFO] [stderr] Finished `test` profile [unoptimized + debuginfo] target(s) in 19.55s [INFO] running `Command { std: "docker" "inspect" "2bda02fd65d438745599e1e53d43d57238b7a4f040811777662b5c3d0383d6d9", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "2bda02fd65d438745599e1e53d43d57238b7a4f040811777662b5c3d0383d6d9", kill_on_drop: false }` [INFO] [stdout] 2bda02fd65d438745599e1e53d43d57238b7a4f040811777662b5c3d0383d6d9 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-3-tc1/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" "RUSTDOCFLAGS=--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:e90291280db7d1fac5b66fc6dad9f9662629e7365a55743daf9bdf73ebc4ea79" "/opt/rustwide/cargo-home/bin/cargo" "+e9385f9eea0221ef295a188d49d16f8f5189abf1" "test" "--frozen", kill_on_drop: false }` [INFO] [stdout] df4eda74d38cb6c73d9a107935c881fba98a30b49b097841ef8f311eb2ffba46 [INFO] running `Command { std: "docker" "start" "-a" "df4eda74d38cb6c73d9a107935c881fba98a30b49b097841ef8f311eb2ffba46", kill_on_drop: false }` [INFO] [stderr] Finished `test` profile [unoptimized + debuginfo] target(s) in 0.22s [INFO] [stderr] Running unittests src/lib.rs (/opt/rustwide/target/debug/deps/gitwatch_rs-e3af676664cbffba) [INFO] [stdout] [INFO] [stdout] running 34 tests [INFO] [stdout] test app_config::tests::test_absolute_paths ... ok [INFO] [stdout] test app_config::tests::test_config_partial_file ... ok [INFO] [stdout] test app_config::tests::test_config_validation ... ok [INFO] [stdout] test app_config::tests::test_config_from_cli ... ok [INFO] [stdout] test cli::tests::test_loglevel_conversion ... ok [INFO] [stdout] test config_file::tests::test_load_empty_config ... ok [INFO] [stdout] test commit_message::tests::test_nonexistent_script ... ok [INFO] [stdout] test app_config::tests::test_config_precedence_cli_only ... ok [INFO] [stdout] test app_config::tests::test_config_precedence_with_file ... ok [INFO] [stdout] test config_file::tests::test_load_config_file ... ok [INFO] [stdout] test app_config::tests::test_relative_paths ... ok [INFO] [stdout] test filter::tests::test_gitignore ... ok [INFO] [stdout] test filter::tests::test_ignore_regex ... ok [INFO] [stdout] test filter::tests::test_path_absolute_error ... ok [INFO] [stderr] [debug] Executing commit message script '/tmp/.tmp55mLC7/test_script.sh' [INFO] [stderr] [debug] Using config file '/tmp/.tmpoBrzFi/gitwatch.yaml' [INFO] [stderr] [debug] Executing commit message script '/tmp/.tmp0KPlHx/test_script.sh' [INFO] [stderr] [debug] Executing commit message script '/tmp/.tmplwwgkz/test_script.sh' [INFO] [stderr] [debug] Executing commit message script '/tmp/.tmpjHUgyq/test_script.sh' [INFO] [stderr] [debug] Using git repository '/tmp/.tmpD8nC8O' [INFO] [stdout] test filter::tests::test_strip_prefix_error ... ok [INFO] [stdout] test config_file::tests::test_load_invalid_config ... ok [INFO] [stdout] test commit_message::tests::test_empty_output ... ok [INFO] [stderr] [trace] Received notify events { events [DebouncedEvent { event: Event { kind: Any, paths: ["test1.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None }, time: Instant { tv_sec: 9868, tv_nsec: 539218564 } }, DebouncedEvent { event: Event { kind: Any, paths: ["test1.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None }, time: Instant { tv_sec: 9868, tv_nsec: 539219734 } }, DebouncedEvent { event: Event { kind: Any, paths: ["test1.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None }, time: Instant { tv_sec: 9868, tv_nsec: 539220394 } }] } [INFO] [stdout] test watcher::tests::test_all_paths_ignored ... ok [INFO] [stderr] [trace] registering event source with poller: token=Token(0), interests=READABLE [INFO] [stderr] [trace] registering event source with poller: token=Token(0), interests=READABLE [INFO] [stderr] [trace] adding inotify watch: /tmp/.tmp6OChRL [INFO] [stderr] [trace] registering event source with poller: token=Token(0), interests=READABLE [INFO] [stdout] Watching for changes... [INFO] [stderr] [trace] adding inotify watch: /tmp/.tmpUAf1jX [INFO] [stderr] [debug] Executing commit message script '/tmp/.tmpcLpJD6/test_script.sh' [INFO] [stdout] Watching for changes... [INFO] [stdout] test commit_message::tests::test_script_execution_failure ... ok [INFO] [stdout] test watcher::tests::test_watcher_notify_error ... ok [INFO] [stdout] test app_config::tests::test_config_from_cli_invalid ... ok [INFO] [stderr] [debug] Generated commit message: '/tmp/.tmpjHUgyq' [INFO] [stderr] [debug] Generated commit message: 'Test commit message' [INFO] [stdout] test util::tests::test_normalize_path ... ok [INFO] [stdout] test commit_message::tests::test_working_directory ... ok [INFO] [stdout] test commit_message::tests::test_successful_script_execution ... ok [INFO] [stdout] test commit_message::tests::test_whitespace_only_output ... ok [INFO] [stderr] [trace] inotify event: Event { wd: WatchDescriptor { id: 1, fd: (Weak) }, mask: EventMask(CREATE), cookie: 0, name: Some("test.txt") } [INFO] [stderr] [trace] raw event: Event { kind: Create(File), paths: ["/tmp/.tmp6OChRL/test.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None } [INFO] [stderr] [trace] inotify event: Event { wd: WatchDescriptor { id: 1, fd: (Weak) }, mask: EventMask(OPEN), cookie: 0, name: Some("test.txt") } [INFO] [stderr] [trace] raw event: Event { kind: Access(Open(Any)), paths: ["/tmp/.tmp6OChRL/test.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None } [INFO] [stderr] [trace] inotify event: Event { wd: WatchDescriptor { id: 1, fd: (Weak) }, mask: EventMask(MODIFY), cookie: 0, name: Some("test.txt") } [INFO] [stderr] [trace] raw event: Event { kind: Modify(Data(Any)), paths: ["/tmp/.tmp6OChRL/test.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None } [INFO] [stderr] [trace] inotify event: Event { wd: WatchDescriptor { id: 1, fd: (Weak) }, mask: EventMask(CLOSE_WRITE), cookie: 0, name: Some("test.txt") } [INFO] [stderr] [trace] raw event: Event { kind: Access(Close(Write)), paths: ["/tmp/.tmp6OChRL/test.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None } [INFO] [stderr] [trace] inotify event: Event { wd: WatchDescriptor { id: 1, fd: (Weak) }, mask: EventMask(CREATE), cookie: 0, name: Some("test.txt") } [INFO] [stderr] [trace] raw event: Event { kind: Create(File), paths: ["/tmp/.tmpUAf1jX/test.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None } [INFO] [stderr] [trace] inotify event: Event { wd: WatchDescriptor { id: 1, fd: (Weak) }, mask: EventMask(OPEN), cookie: 0, name: Some("test.txt") } [INFO] [stderr] [trace] raw event: Event { kind: Access(Open(Any)), paths: ["/tmp/.tmpUAf1jX/test.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None } [INFO] [stderr] [trace] inotify event: Event { wd: WatchDescriptor { id: 1, fd: (Weak) }, mask: EventMask(MODIFY), cookie: 0, name: Some("test.txt") } [INFO] [stderr] [trace] raw event: Event { kind: Modify(Data(Any)), paths: ["/tmp/.tmpUAf1jX/test.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None } [INFO] [stderr] [trace] Received notify events { events [DebouncedEvent { event: Event { kind: Create(File), paths: ["/tmp/.tmpUAf1jX/test.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None }, time: Instant { tv_sec: 9868, tv_nsec: 653151195 } }] } [INFO] [stderr] [warn] Failed to commit changes. Retrying... (1/2). [INFO] [stderr] Error: Mock callback error [INFO] [stderr] [INFO] [stderr] Stack backtrace: [INFO] [stderr] 0: anyhow::error::::msg [INFO] [stderr] at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/anyhow-1.0.98/src/backtrace.rs:27:14 [INFO] [stderr] 1: anyhow::__private::format_err [INFO] [stderr] at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/anyhow-1.0.98/src/lib.rs:694:13 [INFO] [stderr] 2: gitwatch_rs::watcher::tests::test_watcher_callback_error::{{closure}}::{{closure}} [INFO] [stderr] at /opt/rustwide/workdir/src/watcher.rs:178:21 [INFO] [stderr] 3: core::ops::function::impls:: for &F>::call [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/core/src/ops/function.rs:263:22 [INFO] [stderr] 4: gitwatch_rs::watcher::FileWatcher::handle_events [INFO] [stderr] at /opt/rustwide/workdir/src/watcher.rs:96:23 [INFO] [stderr] 5: gitwatch_rs::watcher::FileWatcher::watch [INFO] [stderr] at /opt/rustwide/workdir/src/watcher.rs:60:46 [INFO] [stderr] 6: gitwatch_rs::watcher::tests::test_watcher_callback_error::{{closure}} [INFO] [stderr] at /opt/rustwide/workdir/src/watcher.rs:174:21 [INFO] [stderr] 7: std::sys::backtrace::__rust_begin_short_backtrace [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/sys/backtrace.rs:158:18 [INFO] [stderr] 8: std::thread::Builder::spawn_unchecked_::{{closure}}::{{closure}} [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/thread/mod.rs:559:17 [INFO] [stderr] 9: as core::ops::function::FnOnce<()>>::call_once [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/core/src/panic/unwind_safe.rs:274:9 [INFO] [stderr] 10: std::panicking::catch_unwind::do_call [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/panicking.rs:590:40 [INFO] [stderr] 11: __rust_try [INFO] [stderr] 12: std::panicking::catch_unwind [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/panicking.rs:553:19 [INFO] [stderr] 13: std::panic::catch_unwind [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/panic.rs:359:14 [INFO] [stderr] 14: std::thread::Builder::spawn_unchecked_::{{closure}} [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/thread/mod.rs:557:30 [INFO] [stderr] 15: core::ops::function::FnOnce::call_once{{vtable.shim}} [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/core/src/ops/function.rs:250:5 [INFO] [stderr] 16: as core::ops::function::FnOnce>::call_once [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/alloc/src/boxed.rs:1973:9 [INFO] [stderr] 17: std::sys::thread::unix::Thread::new::thread_start [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/sys/thread/unix.rs:126:17 [INFO] [stderr] 18: [INFO] [stderr] 19: clone [INFO] [stderr] [trace] inotify event: Event { wd: WatchDescriptor { id: 1, fd: (Weak) }, mask: EventMask(CLOSE_WRITE), cookie: 0, name: Some("test.txt") } [INFO] [stderr] [debug] Using git repository '/tmp/.tmpirkBxS' [INFO] [stderr] [debug] Using git repository '/tmp/.tmpRC8v15' [INFO] [stderr] [debug] Repository has uncommitted changes) [INFO] [stdout] test repo::tests::test_empty_repo ... ok [INFO] [stderr] [debug] Modified files: [INFO] [stderr] [debug] foo.txt [INFO] [stderr] [debug] Repository has uncommitted changes) [INFO] [stderr] [debug] Modified files: [INFO] [stderr] [debug] foo.txt [INFO] [stderr] [warn] Watch is disabled [INFO] [stderr] [debug] Using git repository '/tmp/.tmpLDDvJC' [INFO] [stderr] [debug] Using git repository '/tmp/.tmpaNV0A7' [INFO] [stderr] [debug] Using git repository '/tmp/.tmpMru0M6' [INFO] [stderr] [debug] Using git repository '/tmp/.tmpWirfv6' [INFO] [stderr] [trace] raw event: Event { kind: Access(Close(Write)), paths: ["/tmp/.tmpUAf1jX/test.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None } [INFO] [stdout] test app::tests::test_watch_false ... ok [INFO] [stdout] test repo::tests::test_ignore_regex ... ok [INFO] [stderr] [debug] Index is empty [INFO] [stdout] test app::tests::test_commit_on_start ... ok [INFO] [stdout] test repo::tests::test_invalid_commit_message_script ... ok [INFO] [stdout] test repo::tests::test_invalid_remote ... ok [INFO] [stderr] [debug] Pushing to remote origin [INFO] [stderr] [trace] Pushing refspec: HEAD:refs/heads/master [INFO] [stdout] test repo::tests::test_commit_and_push ... ok [INFO] [stderr] [trace] Received notify events { events [DebouncedEvent { event: Event { kind: Create(File), paths: ["/tmp/.tmp6OChRL/test.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None }, time: Instant { tv_sec: 9868, tv_nsec: 644454906 } }, DebouncedEvent { event: Event { kind: Access(Open(Any)), paths: ["/tmp/.tmp6OChRL/test.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None }, time: Instant { tv_sec: 9868, tv_nsec: 644580116 } }, DebouncedEvent { event: Event { kind: Access(Close(Write)), paths: ["/tmp/.tmp6OChRL/test.txt"], attr:tracker: None, attr:flag: None, attr:info: None, attr:source: None }, time: Instant { tv_sec: 9868, tv_nsec: 644798416 } }] } [INFO] [stderr] [warn] Failed to commit changes. Retrying... (2/2). [INFO] [stderr] Error: Mock callback error [INFO] [stderr] [INFO] [stderr] Stack backtrace: [INFO] [stderr] 0: anyhow::error::::msg [INFO] [stderr] at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/anyhow-1.0.98/src/backtrace.rs:27:14 [INFO] [stderr] 1: anyhow::__private::format_err [INFO] [stderr] at /opt/rustwide/cargo-home/registry/src/index.crates.io-1949cf8c6b5b557f/anyhow-1.0.98/src/lib.rs:694:13 [INFO] [stderr] 2: gitwatch_rs::watcher::tests::test_watcher_callback_error::{{closure}}::{{closure}} [INFO] [stderr] at /opt/rustwide/workdir/src/watcher.rs:178:21 [INFO] [stderr] 3: core::ops::function::impls:: for &F>::call [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/core/src/ops/function.rs:263:22 [INFO] [stderr] 4: gitwatch_rs::watcher::FileWatcher::handle_events [INFO] [stderr] at /opt/rustwide/workdir/src/watcher.rs:96:23 [INFO] [stderr] 5: gitwatch_rs::watcher::FileWatcher::watch [INFO] [stderr] at /opt/rustwide/workdir/src/watcher.rs:60:46 [INFO] [stderr] 6: gitwatch_rs::watcher::tests::test_watcher_callback_error::{{closure}} [INFO] [stderr] at /opt/rustwide/workdir/src/watcher.rs:174:21 [INFO] [stderr] 7: std::sys::backtrace::__rust_begin_short_backtrace [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/sys/backtrace.rs:158:18 [INFO] [stderr] 8: std::thread::Builder::spawn_unchecked_::{{closure}}::{{closure}} [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/thread/mod.rs:559:17 [INFO] [stderr] 9: as core::ops::function::FnOnce<()>>::call_once [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/core/src/panic/unwind_safe.rs:274:9 [INFO] [stderr] 10: std::panicking::catch_unwind::do_call [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/panicking.rs:590:40 [INFO] [stderr] 11: __rust_try [INFO] [stderr] 12: std::panicking::catch_unwind [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/panicking.rs:553:19 [INFO] [stderr] 13: std::panic::catch_unwind [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/panic.rs:359:14 [INFO] [stderr] 14: std::thread::Builder::spawn_unchecked_::{{closure}} [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/thread/mod.rs:557:30 [INFO] [stderr] 15: core::ops::function::FnOnce::call_once{{vtable.shim}} [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/core/src/ops/function.rs:250:5 [INFO] [stderr] 16: as core::ops::function::FnOnce>::call_once [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/alloc/src/boxed.rs:1973:9 [INFO] [stderr] 17: std::sys::thread::unix::Thread::new::thread_start [INFO] [stderr] at /rustc/e9385f9eea0221ef295a188d49d16f8f5189abf1/library/std/src/sys/thread/unix.rs:126:17 [INFO] [stderr] 18: [INFO] [stderr] 19: clone [INFO] [stderr] [error] All retry attempts failed: Mock callback error [INFO] [stdout] test watcher::tests::test_watcher_callback_error ... ok [INFO] [stderr] [debug] Received shutdown signal [INFO] [stdout] test watcher::tests::test_watcher_shutdown ... ok [INFO] [stderr] Running unittests src/main.rs (/opt/rustwide/target/debug/deps/gitwatch-bc13c6756f472371) [INFO] [stdout] [INFO] [stdout] test result: ok. 34 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 5.20s [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] running 1 test [INFO] [stdout] test tests::test_main_error_handling ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 1 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.08s [INFO] [stdout] [INFO] [stderr] Running tests/integration_tests.rs (/opt/rustwide/target/debug/deps/integration_tests-36e8e259b848d3c4) [INFO] [stdout] [INFO] [stdout] running 13 tests [INFO] [stdout] test test_main_invalid_path ... ok [INFO] [stdout] test test_completion_command ... ok [INFO] [stdout] test test_invalid_command ... ok [INFO] [stdout] Opened repo '.tmp3U3KKa' at commit '[8f9eb06] Initial commit' [INFO] [stderr] [debug] Using git repository '/tmp/.tmp3U3KKa' [INFO] [stderr] [debug] Using git repository '/tmp/.tmpETCMg6' [INFO] [stderr] [debug] Working tree clean [INFO] [stdout] Opened repo '.tmpETCMg6' at commit '[8f9eb06] Initial commit' [INFO] [stdout] Watching for changes... [INFO] [stderr] [debug] Using git repository '/tmp/.tmpAB9Y7z' [INFO] [stderr] [warn] Watch is disabled [INFO] [stdout] Created commit: 24d438d 'test commit message' [INFO] [stdout] Opened repo '.tmpAB9Y7z' at commit '[8f9eb06] Initial commit' [INFO] [stdout] test test_commit_on_start ... ok [INFO] [stderr] [debug] Using git repository '/tmp/.tmpDPdXep' [INFO] [stdout] Opened repo '.tmpDPdXep' at commit '[8f9eb06] Initial commit' [INFO] [stderr] [debug] Using git repository '/tmp/.tmpWtzRJT' [INFO] [stdout] Opened repo '.tmpWtzRJT' at commit '[8f9eb06] Initial commit' [INFO] [stderr] [debug] Using git repository '/tmp/.tmppODkO1' [INFO] [stdout] Opened repo '.tmppODkO1' at commit '[8f9eb06] Initial commit' [INFO] [stdout] Watching for changes... [INFO] [stderr] [debug] Pushing to remote origin [INFO] [stdout] Created commit: 24d438d 'test commit message' [INFO] [stderr] [debug] Using git repository '/tmp/.tmpPnG2vQ' [INFO] [stdout] Opened repo '.tmpPnG2vQ' at commit '[8f9eb06] Initial commit' [INFO] [stderr] [debug] Repository has uncommitted changes) [INFO] [stdout] test test_push_invalid_remote ... ok [INFO] [stderr] [debug] Modified files: [INFO] [stdout] Opened repo '.tmpf7u6Vh' at commit '[8f9eb06] Initial commit' [INFO] [stderr] [debug] commit-message-script.sh [INFO] [stdout] Created commit: 24d438d 'test commit message' [INFO] [stderr] [debug] Using git repository '/tmp/.tmpEd6G6u' [INFO] [stderr] [debug] Using git repository '/tmp/.tmpf7u6Vh' [INFO] [stderr] [debug] Pushing to remote origin [INFO] [stdout] Created commit: 24d438d 'test commit message' [INFO] [stdout] Opened repo '.tmpEd6G6u' at commit '[8f9eb06] Initial commit' [INFO] [stdout] Watching for changes... [INFO] [stderr] [debug] Executing commit message script '/tmp/.tmpPnG2vQ/commit-message-script.sh' [INFO] [stderr] [debug] Working tree clean [INFO] [stdout] Pushed changes to origin [INFO] [stderr] [debug] Generated commit message: 'generated commit message' [INFO] [stdout] Commit message: [INFO] [stderr] [warn] Watch is disabled [INFO] [stdout] test commit message [INFO] [stderr] [warn] Changes will not be commited (dry-run enabled)! [INFO] [stdout] Staged files: [INFO] [stderr] [warn] Watch is disabled [INFO] [stdout] foo.txt [INFO] [stderr] [warn] Watch is disabled [INFO] [stdout]  [INFO] [stdout] Created commit: 7983702 'generated commit message' [INFO] [stdout] test test_dry_run ... ok [INFO] [stdout] test test_push ... ok [INFO] [stdout] test test_commit_message_script ... ok [INFO] [stdout] Watching for changes... [INFO] [stdout] test test_main_valid_args ... ok [INFO] [stderr] [debug] Detected changes: [INFO] [stderr] foo.txt [INFO] [stdout] Created commit: b78023a 'test commit message' [INFO] [stderr] [debug] Received shutdown signal [INFO] [stderr] [debug] Received shutdown signal [INFO] [stderr] [debug] Received shutdown signal [INFO] [stdout] test test_watch ... ok [INFO] [stdout] test test_ignore_regex ... ok [INFO] [stdout] test test_gitignore ... ok [INFO] [stderr] [debug] Detected changes: [INFO] [stderr] foo.txt [INFO] [stdout] Created commit: 4761cb3 'test commit message' [INFO] [stderr] [debug] Received shutdown signal [INFO] [stdout] test test_debounce ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 13 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 2.69s [INFO] [stdout] [INFO] [stderr] Doc-tests gitwatch_rs [INFO] [stdout] [INFO] [stdout] running 0 tests [INFO] [stdout] [INFO] [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.00s [INFO] [stdout] [INFO] running `Command { std: "docker" "inspect" "df4eda74d38cb6c73d9a107935c881fba98a30b49b097841ef8f311eb2ffba46", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "df4eda74d38cb6c73d9a107935c881fba98a30b49b097841ef8f311eb2ffba46", kill_on_drop: false }` [INFO] [stdout] df4eda74d38cb6c73d9a107935c881fba98a30b49b097841ef8f311eb2ffba46