[INFO] fetching crate nils-macos-agent 0.6.5... [INFO] testing nils-macos-agent-0.6.5 against try#dec9417b8611e34e787a3e4c37686b5131f9e5c5 for pr-154210-2 [INFO] extracting crate nils-macos-agent 0.6.5 into /workspace/builds/worker-5-tc2/source [INFO] started tweaking crates.io crate nils-macos-agent 0.6.5 [INFO] removed 0 missing tests [INFO] finished tweaking crates.io crate nils-macos-agent 0.6.5 [INFO] tweaked toml for crates.io crate nils-macos-agent 0.6.5 written to /workspace/builds/worker-5-tc2/source/Cargo.toml [INFO] validating manifest of crates.io crate nils-macos-agent 0.6.5 on toolchain dec9417b8611e34e787a3e4c37686b5131f9e5c5 [INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+dec9417b8611e34e787a3e4c37686b5131f9e5c5" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }` [INFO] crate crates.io crate nils-macos-agent 0.6.5 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" "+dec9417b8611e34e787a3e4c37686b5131f9e5c5" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }` [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/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:d429b63d4308055ea97f60fb1d3dfca48854a00942f1bd2ad806beaf015945ec" "/opt/rustwide/cargo-home/bin/cargo" "+dec9417b8611e34e787a3e4c37686b5131f9e5c5" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }` [INFO] [stdout] f08dcf92bb8f1917d34e4bdf1e7114fdddc95fe9742e0d6ffa547111d0faedb3 [INFO] running `Command { std: "docker" "start" "-a" "f08dcf92bb8f1917d34e4bdf1e7114fdddc95fe9742e0d6ffa547111d0faedb3", kill_on_drop: false }` [INFO] running `Command { std: "docker" "inspect" "f08dcf92bb8f1917d34e4bdf1e7114fdddc95fe9742e0d6ffa547111d0faedb3", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "f08dcf92bb8f1917d34e4bdf1e7114fdddc95fe9742e0d6ffa547111d0faedb3", kill_on_drop: false }` [INFO] [stdout] f08dcf92bb8f1917d34e4bdf1e7114fdddc95fe9742e0d6ffa547111d0faedb3 [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/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:d429b63d4308055ea97f60fb1d3dfca48854a00942f1bd2ad806beaf015945ec" "/opt/rustwide/cargo-home/bin/cargo" "+dec9417b8611e34e787a3e4c37686b5131f9e5c5" "build" "--frozen" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] d195edda8b61864f8417e77c280f275e4a9c1d9319b557f67a51444514391bdd [INFO] running `Command { std: "docker" "start" "-a" "d195edda8b61864f8417e77c280f275e4a9c1d9319b557f67a51444514391bdd", kill_on_drop: false }` [INFO] [stderr] Compiling syn v2.0.117 [INFO] [stderr] Compiling crossbeam-utils v0.8.21 [INFO] [stderr] Compiling parking v2.2.1 [INFO] [stderr] Compiling winnow v0.7.15 [INFO] [stderr] Compiling equivalent v1.0.2 [INFO] [stderr] Compiling libc v0.2.182 [INFO] [stderr] Compiling rustix v1.1.4 [INFO] [stderr] Compiling linux-raw-sys v0.12.1 [INFO] [stderr] Compiling futures-io v0.3.32 [INFO] [stderr] Compiling endi v1.1.1 [INFO] [stderr] Compiling async-io v2.6.0 [INFO] [stderr] Compiling async-task v4.7.1 [INFO] [stderr] Compiling simd-adler32 v0.3.8 [INFO] [stderr] Compiling anstream v0.6.21 [INFO] [stderr] Compiling nix v0.31.2 [INFO] [stderr] Compiling indexmap v2.13.0 [INFO] [stderr] Compiling futures-lite v2.6.1 [INFO] [stderr] Compiling clap_lex v1.0.0 [INFO] [stderr] Compiling tracing-core v0.1.36 [INFO] [stderr] Compiling piper v0.2.5 [INFO] [stderr] Compiling miniz_oxide v0.8.9 [INFO] [stderr] Compiling serde_json v1.0.149 [INFO] [stderr] Compiling clap_builder v4.5.60 [INFO] [stderr] Compiling fdeflate v0.3.7 [INFO] [stderr] Compiling concurrent-queue v2.5.0 [INFO] [stderr] Compiling uuid v1.22.0 [INFO] [stderr] Compiling ordered-stream v0.2.0 [INFO] [stderr] Compiling zune-core v0.5.1 [INFO] [stderr] Compiling event-listener v5.4.1 [INFO] [stderr] Compiling pxfm v0.1.28 [INFO] [stderr] Compiling nils-screen-record v0.6.5 [INFO] [stderr] Compiling quick-error v2.0.1 [INFO] [stderr] Compiling event-listener-strategy v0.5.4 [INFO] [stderr] Compiling x11rb-protocol v0.13.2 [INFO] [stderr] Compiling image-webp v0.2.4 [INFO] [stderr] Compiling chrono v0.4.44 [INFO] [stderr] Compiling regex-automata v0.4.14 [INFO] [stderr] Compiling async-channel v2.5.0 [INFO] [stderr] Compiling async-lock v3.4.2 [INFO] [stderr] Compiling flate2 v1.1.9 [INFO] [stderr] Compiling async-executor v1.14.0 [INFO] [stderr] Compiling blocking v1.6.2 [INFO] [stderr] Compiling async-broadcast v0.7.2 [INFO] [stderr] Compiling png v0.18.1 [INFO] [stderr] Compiling zune-jpeg v0.5.12 [INFO] [stderr] Compiling bytemuck v1.25.0 [INFO] [stderr] Compiling toml_parser v1.0.9+spec-1.1.0 [INFO] [stderr] Compiling errno v0.3.14 [INFO] [stderr] Compiling signal-hook-registry v1.4.8 [INFO] [stderr] Compiling toml_edit v0.25.4+spec-1.1.0 [INFO] [stderr] Compiling ctrlc v3.5.2 [INFO] [stderr] Compiling regex v1.12.3 [INFO] [stderr] Compiling proc-macro-crate v3.5.0 [INFO] [stderr] Compiling moxcms v0.7.11 [INFO] [stderr] Compiling serde_derive v1.0.228 [INFO] [stderr] Compiling enumflags2_derive v0.7.12 [INFO] [stderr] Compiling clap_derive v4.5.55 [INFO] [stderr] Compiling tracing-attributes v0.1.31 [INFO] [stderr] Compiling thiserror-impl v2.0.18 [INFO] [stderr] Compiling serde_repr v0.1.20 [INFO] [stderr] Compiling async-recursion v1.1.1 [INFO] [stderr] Compiling async-trait v0.1.89 [INFO] [stderr] Compiling tracing v0.1.44 [INFO] [stderr] Compiling polling v3.11.0 [INFO] [stderr] Compiling gethostname v1.1.0 [INFO] [stderr] Compiling thiserror v2.0.18 [INFO] [stderr] Compiling nils-common v0.6.5 [INFO] [stderr] Compiling clap v4.5.60 [INFO] [stderr] Compiling clap_complete v4.5.66 [INFO] [stderr] Compiling x11rb v0.13.2 [INFO] [stderr] Compiling serde v1.0.228 [INFO] [stderr] Compiling async-signal v0.2.13 [INFO] [stderr] Compiling async-process v2.5.0 [INFO] [stderr] Compiling zvariant_utils v3.3.0 [INFO] [stderr] Compiling enumflags2 v0.7.12 [INFO] [stderr] Compiling zvariant_derive v5.10.0 [INFO] [stderr] Compiling zvariant v5.10.0 [INFO] [stderr] Compiling image v0.25.9 [INFO] [stderr] Compiling zbus_names v4.3.1 [INFO] [stderr] Compiling zbus_macros v5.14.0 [INFO] [stderr] Compiling zbus v5.14.0 [INFO] [stderr] Compiling nils-macos-agent v0.6.5 (/opt/rustwide/workdir) [INFO] [stderr] Finished `dev` profile [unoptimized + debuginfo] target(s) in 1m 22s [INFO] running `Command { std: "docker" "inspect" "d195edda8b61864f8417e77c280f275e4a9c1d9319b557f67a51444514391bdd", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "d195edda8b61864f8417e77c280f275e4a9c1d9319b557f67a51444514391bdd", kill_on_drop: false }` [INFO] [stdout] d195edda8b61864f8417e77c280f275e4a9c1d9319b557f67a51444514391bdd [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/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:d429b63d4308055ea97f60fb1d3dfca48854a00942f1bd2ad806beaf015945ec" "/opt/rustwide/cargo-home/bin/cargo" "+dec9417b8611e34e787a3e4c37686b5131f9e5c5" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }` [INFO] [stdout] 193c6d01b095386c0da86200fa44d50f687cef202661780815985546ddb32c9b [INFO] running `Command { std: "docker" "start" "-a" "193c6d01b095386c0da86200fa44d50f687cef202661780815985546ddb32c9b", kill_on_drop: false }` [INFO] [stderr] Compiling rustix v1.1.4 [INFO] [stderr] Compiling yansi v1.0.1 [INFO] [stderr] Compiling diff v0.1.13 [INFO] [stderr] Compiling getrandom v0.4.2 [INFO] [stderr] Compiling pretty_assertions v1.4.1 [INFO] [stderr] Compiling polling v3.11.0 [INFO] [stderr] Compiling gethostname v1.1.0 [INFO] [stderr] Compiling tempfile v3.26.0 [INFO] [stderr] Compiling x11rb v0.13.2 [INFO] [stderr] Compiling async-io v2.6.0 [INFO] [stderr] Compiling nils-test-support v0.6.5 [INFO] [stderr] Compiling async-signal v0.2.13 [INFO] [stderr] Compiling async-process v2.5.0 [INFO] [stderr] Compiling zbus v5.14.0 [INFO] [stderr] Compiling nils-screen-record v0.6.5 [INFO] [stderr] Compiling nils-macos-agent v0.6.5 (/opt/rustwide/workdir) [INFO] [stderr] Finished `test` profile [unoptimized + debuginfo] target(s) in 35.57s [INFO] running `Command { std: "docker" "inspect" "193c6d01b095386c0da86200fa44d50f687cef202661780815985546ddb32c9b", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "193c6d01b095386c0da86200fa44d50f687cef202661780815985546ddb32c9b", kill_on_drop: false }` [INFO] [stdout] 193c6d01b095386c0da86200fa44d50f687cef202661780815985546ddb32c9b [INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc2/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:d429b63d4308055ea97f60fb1d3dfca48854a00942f1bd2ad806beaf015945ec" "/opt/rustwide/cargo-home/bin/cargo" "+dec9417b8611e34e787a3e4c37686b5131f9e5c5" "test" "--frozen", kill_on_drop: false }` [INFO] [stdout] ef98ee0c2acb2ab0bb160513933cd2eff2da763195964a805313eeef91d02f71 [INFO] running `Command { std: "docker" "start" "-a" "ef98ee0c2acb2ab0bb160513933cd2eff2da763195964a805313eeef91d02f71", 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/macos_agent-9e16d2d80f57e461) [INFO] [stdout] [INFO] [stdout] running 129 tests [INFO] [stdout] test backend::applescript::tests::ax_type_script_declares_node_id_helper_once ... ok [INFO] [stdout] test backend::applescript::tests::ax_click_contract_failure_requires_fallback_coordinate_pair ... ok [INFO] [stdout] test backend::applescript::tests::ax_click_script_declares_node_id_helper_once ... ok [INFO] [stdout] test backend::applescript::tests::ax_type_contract_failure_requires_text_length ... ok [INFO] [stdout] test backend::applescript::tests::ax_list_contract_failure_reports_missing_nodes_array ... ok [INFO] [stdout] test backend::applescript::tests::ax_list_uses_test_mode_default_when_stdout_is_empty ... ok [INFO] [stdout] test backend::applescript::tests::parses_modifiers_deduped_and_canonicalized ... ok [INFO] [stdout] test backend::applescript::tests::ax_type_uses_test_mode_override_without_invoking_runner ... ok [INFO] [stdout] test backend::applescript::tests::escapes_applescript_string_literals ... ok [INFO] [stdout] test backend::applescript::tests::rejects_unknown_modifier ... ok [INFO] [stdout] test backend::cliclick::tests::maps_button_name ... ok [INFO] [stdout] test backend::hammerspoon::tests::ax_list_script_prelude_has_valid_unquoted_fail_message ... ok [INFO] [stdout] test backend::hammerspoon::tests::empty_override_value_falls_back_to_default_fixture ... ok [INFO] [stdout] test backend::hammerspoon::tests::not_found_failure_is_marked_backend_unavailable ... ok [INFO] [stdout] test backend::hammerspoon::tests::selector_and_preview_helpers_cover_expected_cases ... ok [INFO] [stdout] test backend::hammerspoon::tests::validation_errors_are_reported_for_empty_hammerspoon_inputs ... ok [INFO] [stdout] test backend::hammerspoon::tests::test_mode_override_is_honored_for_click ... ok [INFO] [stdout] test backend::tests::applescript_backend_reports_unsupported_for_ax_extension_methods ... ok [INFO] [stdout] test backend::process::tests::maps_timeout_failure_to_runtime_error ... ok [INFO] [stdout] test backend::hammerspoon::tests::default_test_mode_fixtures_cover_all_hammerspoon_ax_operations ... ok [INFO] [stdout] test backend::tests::auto_backend_auto_preference_uses_hammerspoon_first_when_available ... ok [INFO] [stdout] test backend::hammerspoon::tests::invalid_override_json_reports_parse_hint ... ok [INFO] [stdout] test backend::tests::backend_preference_env_overrides_test_mode_default ... ok [INFO] [stdout] test backend::hammerspoon::tests::message_port_error_is_marked_backend_unavailable ... ok [INFO] [stdout] test backend::tests::auto_backend_hammerspoon_preference_routes_list_click_type ... ok [INFO] [stdout] test backend::input_source::tests::switch_returns_simulated_state_in_test_mode ... ok [INFO] [stdout] test backend::input_source::tests::normalize_token_maps_common_aliases ... ok [INFO] [stdout] test backend::input_source::tests::normalize_token_preserves_case_for_full_source_id ... ok [INFO] [stdout] test backend::tests::backend_preference_defaults_to_applescript_in_test_mode ... ok [INFO] [stdout] test cli::tests::parses_ax_list_with_filters ... ok [INFO] [stdout] test backend::process::tests::reports_not_found ... ok [INFO] [stdout] test backend::tests::auto_backend_ax_extension_methods_route_through_hammerspoon ... ok [INFO] [stdout] test backend::process::tests::non_zero_stderr_is_compacted ... ok [INFO] [stdout] test cli::tests::parses_ax_click_gate_and_postcondition_flags ... ok [INFO] [stdout] test backend::input_source::tests::current_uses_test_mode_env_when_enabled ... ok [INFO] [stdout] test cli::tests::parses_input_type_submit ... ok [INFO] [stdout] test cli::tests::parses_ax_attr_get_and_set_commands ... ok [INFO] [stdout] test cli::tests::parses_ax_wait_policy_overrides ... ok [INFO] [stdout] test cli::tests::parses_debug_bundle_and_observe_selector_padding_flags ... ok [INFO] [stdout] test cli::tests::parses_input_source_switch_command ... ok [INFO] [stdout] test cli::tests::parses_window_activate_command_tree ... ok [INFO] [stdout] test cli::tests::parses_wait_window_present_with_window_title_contains ... ok [INFO] [stdout] test cli::tests::parses_wait_ax_present_with_match_strategy_and_explain ... ok [INFO] [stdout] test cli::tests::parses_wait_window_present ... ok [INFO] [stdout] test cli::tests::parses_ax_type_compound_selector ... ok [INFO] [stdout] test commands::ax_action::tests::run_perform_rejects_tsv ... ok [INFO] [stdout] test commands::ax_attr::tests::parse_value_covers_supported_types ... ok [INFO] [stdout] test commands::ax_action::tests::run_perform_dry_run_supports_text_and_json ... ok [INFO] [stdout] test commands::ax_attr::tests::parse_value_reports_expected_usage_errors ... ok [INFO] [stdout] test commands::ax_attr::tests::value_type_name_matches_cli_values ... ok [INFO] [stdout] test cli::tests::rejects_ax_type_nth_without_selector_filter ... ok [INFO] [stdout] test commands::ax_common::tests::action_gate_options_any_enabled_checks_all_flags ... ok [INFO] [stdout] test commands::ax_common::tests::build_selector_rejects_invalid_combinations ... ok [INFO] [stdout] test cli::tests::parses_ax_click_reselect_and_fallback_order ... ok [INFO] [stdout] test commands::ax_common::tests::evaluate_selector_by_node_id_and_role_filters ... ok [INFO] [stdout] test cli::tests::rejects_ax_click_mixed_selectors ... ok [INFO] [stdout] test commands::ax_common::tests::selector_selection_error_and_postcondition_parsing_are_stable ... ok [INFO] [stdout] test commands::ax_common::tests::build_selector_validates_regex_patterns ... ok [INFO] [stdout] test commands::ax_session::tests::run_list_covers_non_empty_text_and_tsv_rejection ... ok [INFO] [stdout] test commands::ax_common::tests::build_target_rejects_conflicting_target_modes ... ok [INFO] [stdout] test cli::tests::rejects_ax_list_multiple_target_selectors ... ok [INFO] [stdout] test cli::tests::parses_window_activate_reopen_on_fail_flag ... ok [INFO] [stdout] test cli::tests::parses_ax_click_node_id_selector ... ok [INFO] [stdout] test commands::ax_attr::tests::run_get_and_set_return_usage_error_for_tsv_format ... ok [INFO] [stdout] test commands::ax_session::tests::run_list_text_supports_empty_sessions_branch ... ok [INFO] [stdout] test commands::ax_session::tests::run_start_and_stop_reject_tsv_in_dry_run ... ok [INFO] [stdout] test commands::ax_session::tests::run_start_and_stop_dry_run_support_text_and_json ... ok [INFO] [stdout] test commands::ax_watch::tests::run_start_and_stop_dry_run_support_text_and_json ... ok [INFO] [stdout] test commands::input_hotkey::tests::validate_key_accepts_single_char_and_named_key ... ok [INFO] [stdout] test commands::input_hotkey::tests::validate_key_rejects_long_unknown_key ... ok [INFO] [stdout] test commands::ax_common::tests::evaluate_selector_reports_ambiguous_and_nth_out_of_range ... ok [INFO] [stdout] test commands::list::tests::target_selector_from_debug_args_defaults_to_active_window_and_preserves_explicit_values ... ok [INFO] [stdout] test commands::list::tests::resolve_debug_output_dir_uses_explicit_output_dir_when_provided ... ok [INFO] [stdout] test cli::tests::rejects_window_title_contains_without_app ... ok [INFO] [stdout] test commands::list::tests::run_debug_bundle_reports_output_dir_creation_error ... ok [INFO] [stdout] test commands::list::tests::agents_out_dir_uses_agent_home_then_home_then_dot_agents ... ok [INFO] [stdout] test commands::list::tests::push_artifact_json_records_error_when_parent_is_a_file ... ok [INFO] [stdout] test cli::tests::parses_ax_action_session_and_watch_commands ... ok [INFO] [stdout] test commands::observe::tests::padded_region_clamps_to_window_bounds ... ok [INFO] [stdout] test commands::observe::tests::padded_region_errors_when_result_collapses ... ok [INFO] [stdout] test commands::observe::tests::preserve_explicit_output_path ... ok [INFO] [stdout] test commands::scenario::tests::parse_scenario_file ... ok [INFO] [stdout] test commands::window_activate::tests::resolve_target_accepts_bundle_id_and_app_without_lookup ... ok [INFO] [stdout] test commands::window_activate::tests::selector_label_formats_other_selectors ... ok [INFO] [stdout] test commands::window_activate::tests::selector_label_prefers_window_id ... ok [INFO] [stdout] test model::tests::normalize_tsv_field_replaces_control_whitespace ... ok [INFO] [stdout] test commands::scenario::tests::extract_step_telemetry_maps_ax_fallback_modes ... ok [INFO] [stdout] test commands::ax_common::tests::evaluate_selector_supports_match_strategies_and_explain_output ... ok [INFO] [stdout] test commands::profile::tests::profile_issues_include_key_paths ... ok [INFO] [stdout] test commands::ax_watch::tests::run_start_and_stop_reject_tsv_in_dry_run ... ok [INFO] [stdout] test commands::window_activate::tests::wait_for_active_confirmation_short_circuits_on_zero_or_test_mode ... ok [INFO] [stdout] test commands::list::tests::run_debug_bundle_json_writes_complete_bundle_in_test_mode ... ok [INFO] [stdout] test retry::tests::retries_runtime_errors_until_success ... ok [INFO] [stdout] test commands::list::tests::run_debug_bundle_text_records_partial_failures_and_keeps_writing_index ... ok [INFO] [stdout] test run::tests::allows_tsv_for_windows_list ... ok [INFO] [stdout] test commands::list::tests::run_debug_bundle_tsv_is_rejected_for_debug_bundle ... ok [INFO] [stdout] test screen_record_adapter::tests::crop_image_reports_decode_error_for_non_image_input ... ok [INFO] [stdout] test retry::tests::does_not_retry_usage_errors ... ok [INFO] [stdout] test run::tests::rejects_tsv_for_non_list_commands ... ok [INFO] [stdout] test screen_record_adapter::tests::map_error_preserves_usage_and_runtime_exit_code ... ok [INFO] [stdout] test cli::tests::parses_ax_type_role_without_title_contains ... ok [INFO] [stdout] test screen_record_adapter::tests::crop_image_writes_bounded_output ... ok [INFO] [stdout] test screen_record_adapter::tests::test_screenshot_fixture_supports_jpg_and_webp_formats ... ok [INFO] [stdout] test targets::tests::extension_format_supports_expected_values ... ok [INFO] [stdout] test cli::tests::rejects_multiple_window_activate_selectors ... ok [INFO] [stdout] test preflight::tests::helpers_cover_path_detection_and_sanitization ... ok [INFO] [stdout] test preflight::tests::collect_snapshot_uses_stubbed_tools ... ok [INFO] [stdout] test preflight::tests::collect_snapshot_without_osascript_marks_permission_unknown ... ok [INFO] [stdout] test targets::tests::screen_record_error_mapping_preserves_usage_and_runtime ... ok [INFO] [stdout] test preflight::tests::probe_accessibility_covers_success_and_error_modes ... ok [INFO] [stdout] test commands::ax_watch::tests::run_poll_covers_event_text_and_tsv_rejection ... ok [INFO] [stdout] test commands::window_activate::tests::resolve_target_uses_target_lookup_for_active_window ... ok [INFO] [stdout] test preflight::tests::probe_automation_covers_blocked_and_unknown ... ok [INFO] [stdout] test wait::tests::wait_until_succeeds_before_timeout ... ok [INFO] [stdout] test preflight::tests::probe_input_hotkey_uses_non_esc_key_and_maps_failures ... ok [INFO] [stdout] test wait::tests::wait_until_errors_on_timeout ... ok [INFO] [stdout] test preflight::tests::run_osascript_reports_spawn_failures ... ok [INFO] [stdout] test run::tests::platform_gate_maps_non_macos_to_usage_error_unless_test_mode ... ok [INFO] [stdout] test targets::tests::capture_screenshot_region_crops_fixture_in_test_mode ... ok [INFO] [stdout] test targets::tests::capture_screenshot_uses_test_fixture_in_test_mode ... ok [INFO] [stdout] test screen_record_adapter::tests::macos_only_screen_record_functions_return_unsupported_on_non_macos ... ok [INFO] [stdout] test backend::applescript::tests::ax_click_parse_failure_includes_operation_context ... ok [INFO] [stdout] test targets::tests::list_apps_is_deterministic ... ok [INFO] [stdout] test targets::tests::list_windows_is_sorted_and_filtered_in_test_mode ... ok [INFO] [stdout] test targets::tests::resolve_window_by_window_id ... ok [INFO] [stdout] test targets::tests::window_present_and_app_activity_cover_selector_variants ... ok [INFO] [stderr] Running unittests src/main.rs (/opt/rustwide/target/debug/deps/macos_agent-b1d68f278722da5b) [INFO] [stdout] test test_mode::tests::enabled_accepts_truthy_values ... ok [INFO] [stdout] test test_mode::tests::enabled_is_false_when_missing ... ok [INFO] [stdout] test test_mode::tests::timestamp_uses_explicit_env_in_test_mode ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 129 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.31s [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] running 1 test [INFO] [stdout] test tests::command_label_maps_ax_subcommands ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 1 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.04s [INFO] [stdout] [INFO] [stderr] Running tests/ax_extended.rs (/opt/rustwide/target/debug/deps/ax_extended-0f82506c00ed517d) [INFO] [stdout] [INFO] [stdout] running 11 tests [INFO] [stdout] test ax_action_perform_text_output_is_emitted ... ok [INFO] [stdout] test ax_attr_get_json_supports_override_payload ... ok [INFO] [stdout] test ax_attr_set_dry_run_bool_value_type_is_reported ... ok [INFO] [stdout] test ax_attr_set_rejects_invalid_bool_value ... ok [INFO] [stdout] test ax_attr_set_rejects_non_finite_number_value ... ok [INFO] [stdout] test ax_click_gate_timeout_reports_actionable_gate_operation ... ok [INFO] [stdout] test ax_click_gate_and_postcondition_metadata_are_emitted_in_json ... ok [INFO] [stdout] test ax_watch_start_poll_stop_json_contracts ... ok [INFO] [stdout] test ax_session_start_list_stop_json_contracts ... ok [INFO] [stdout] test ax_commands_can_force_hammerspoon_backend_for_list_click_type ... ok [INFO] [stdout] test ax_type_postcondition_mismatch_has_distinct_operation ... ok [INFO] [stderr] Running tests/cli_smoke.rs (/opt/rustwide/target/debug/deps/cli_smoke-8fafd8297eec9353) [INFO] [stdout] [INFO] [stdout] test result: ok. 11 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.08s [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] running 11 tests [INFO] [stdout] test help_lists_command_groups ... ok [INFO] [stdout] test input_type_submit_sets_enter_and_policy ... ok [INFO] [stdout] test ax_click_rejects_mixed_selectors ... ok [INFO] [stdout] test windows_list_window_title_contains_emits_json_payload ... ok [INFO] [stdout] test trace_command_label_stays_in_sync_with_runtime_mapping ... ok [INFO] [stdout] test observe_screenshot_help_lists_if_changed_flags ... ok [INFO] [stdout] test input_source_current_and_switch_emit_json_payloads ... ok [INFO] [stdout] test preflight_json_smoke ... ok [INFO] [stdout] test ax_help_lists_subcommands ... ok [INFO] [stderr] Running tests/common.rs (/opt/rustwide/target/debug/deps/common-c22612451221e43c) [INFO] [stdout] test ax_click_help_lists_wait_policy_overrides ... ok [INFO] [stdout] test tsv_mode_is_rejected_for_input_commands ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 11 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.08s [INFO] [stdout] [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] [stderr] Running tests/completion_outside_repo.rs (/opt/rustwide/target/debug/deps/completion_outside_repo-a1329281af26d7dc) [INFO] [stdout] [INFO] [stdout] running 2 tests [INFO] [stdout] test completion_rejects_unknown_shell_outside_git_repo ... ok [INFO] [stdout] test completion_export_succeeds_outside_git_repo ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 2 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.02s [INFO] [stdout] [INFO] [stderr] Running tests/contracts.rs (/opt/rustwide/target/debug/deps/contracts-caf81c9125bedf5c) [INFO] [stdout] [INFO] [stdout] running 9 tests [INFO] [stdout] test preflight_permissions_contract_has_stable_keys ... ok [INFO] [stdout] test mutating_commands_emit_unified_json_envelope_schema ... ok [INFO] [stdout] test error_format_json_emits_machine_parseable_payload ... ok [INFO] [stdout] test trace_writes_artifacts_for_success_and_failure ... ok [INFO] [stdout] test trace_command_labels_include_ax_commands ... ok [INFO] [stdout] test trace_dir_not_writable_is_actionable_runtime_error ... ok [INFO] [stdout] test debug_bundle_emits_artifact_index_and_partial_failure_entries ... ok [INFO] [stdout] test error_commands_write_stderr_only_with_error_prefix ... ok [INFO] [stdout] test success_commands_write_stdout_only ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 9 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.17s [INFO] [stdout] [INFO] [stderr] Running tests/e2e_real_apps.rs (/opt/rustwide/target/debug/deps/e2e_real_apps-9027a58d51a90b85) [INFO] [stdout] [INFO] [stdout] running 25 tests [INFO] [stdout] test arc_youtube_multi_video_play_pause_and_comments_test ... ok [INFO] [stdout] test arc_youtube_play_pause_and_comment_checkpoint_test ... ok [INFO] [stdout] test arc_youtube_opens_home_and_clicks_three_tiles_test ... ok [INFO] [stdout] test cross_app_arc_spotify_focus_and_state_recovery_test ... ok [INFO] [stdout] test finder_navigation_and_state_checks_test ... ok [INFO] [stdout] test matrix_runner_supports_app_subset_selection_real ... ok [INFO] [stdout] test matrix_runner_reports_base_and_extended_scenarios_separately ... ok [INFO] [stdout] test real_apps::arc_navigation::tests::select_ax_candidate_filters_title_case_insensitively ... ok [INFO] [stdout] test matrix_runner_supports_app_subset_selection ... ok [INFO] [stdout] test real_apps::arc_navigation::tests::select_ax_candidate_prefers_nearest_anchor ... ok [INFO] [stdout] test matrix_runner_emits_artifact_index_with_required_fields ... ok [INFO] [stdout] test real_apps::matrix::tests::app_subset_selection_defaults_to_all ... ok [INFO] [stdout] test real_apps::matrix::tests::app_subset_selection_filters_unsupported_apps ... ok [INFO] [stdout] test real_apps::matrix::tests::app_subset_selection_is_deterministic ... ok [INFO] [stdout] test real_apps::arc_navigation::tests::select_ax_candidate_respects_nth_after_anchor_sort ... ok [INFO] [stdout] test real_apps::matrix::tests::summarize_soak_reports_pass_rate_and_failing_steps ... ok [INFO] [stdout] test real_apps::matrix::tests::write_artifact_index_includes_required_fields ... ok [INFO] [stdout] test real_e2e_contract_enforces_skip_vs_fail_policy ... ok [INFO] [stdout] test real_e2e_foundation_collects_artifacts ... ok [INFO] [stdout] test spotify_player_state_transitions_are_observable_test ... ok [INFO] [stdout] test real_apps::matrix::tests::classify_base_vs_extended_separates_summary_buckets ... ok [INFO] [stdout] test real_e2e_foundation_reports_preflight_and_skip_reasons ... ok [INFO] [stdout] test spotify_ui_selects_track_and_toggles_playback_test ... ok [INFO] [stdout] test real_common_profile_loader_and_artifact_paths_are_deterministic ... ok [INFO] [stdout] test real_apps::arc_navigation::tests::collect_click_candidates_ignores_invalid_frames ... ok [INFO] [stderr] Running tests/e2e_real_macos.rs (/opt/rustwide/target/debug/deps/e2e_real_macos-8eaf7b6ba6f41da6) [INFO] [stdout] [INFO] [stderr] Running tests/input_click.rs (/opt/rustwide/target/debug/deps/input_click-7b2d9a4844b4d94c) [INFO] [stdout] test result: ok. 25 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.12s [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] running 2 tests [INFO] [stdout] test real_macos_preflight_reports_tcc_signals_in_json ... ok [INFO] [stdout] test real_macos_activate_and_wait_detects_focus_or_reports_actionable_tcc_error ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 2 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.00s [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] running 6 tests [INFO] [stdout] test input_click_dry_run_does_not_execute_backend ... ok [INFO] [stdout] test input_click_double_click_succeeds ... ok [INFO] [stdout] test input_click_runtime_error_from_cliclick_is_concise ... ok [INFO] [stdout] test input_click_invalid_count_is_usage_error ... ok [INFO] [stdout] test ax_click_dry_run_reports_policy_and_meta ... ok [INFO] [stderr] Running tests/input_keyboard.rs (/opt/rustwide/target/debug/deps/input_keyboard-1e698d563fdf8527) [INFO] [stdout] test ax_click_coordinate_fallback_executes_with_backend_coordinates ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 6 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.35s [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] running 7 tests [INFO] [stdout] test ax_type_dry_run_reports_policy_and_text_length ... ok [INFO] [stdout] test input_hotkey_rejects_invalid_modifier ... ok [INFO] [stdout] test input_type_accepts_whitespace_and_punctuation ... ok [INFO] [stdout] test ax_type_reports_keyboard_fallback_when_backend_uses_it ... ok [INFO] [stdout] test input_type_timeout_surfaces_as_runtime_error ... ok [INFO] [stdout] test input_keyboard_rejects_tsv_output_mode ... ok [INFO] [stdout] test input_hotkey_json_reports_modifiers ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 7 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.05s [INFO] [stdout] [INFO] [stderr] Running tests/list_commands.rs (/opt/rustwide/target/debug/deps/list_commands-5235b3ef42c42ac1) [INFO] [stdout] [INFO] [stdout] running 4 tests [INFO] [stdout] test ax_list_json_emits_expected_node_fields ... ok [INFO] [stdout] test windows_list_tsv_is_deterministic ... ok [INFO] [stdout] test apps_list_json_has_schema_version ... ok [INFO] [stdout] test windows_list_json_and_apps_list_tsv_are_both_supported ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 4 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.05s [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] running 4 tests [INFO] [stderr] Running tests/observe_screenshot.rs (/opt/rustwide/target/debug/deps/observe_screenshot-db1a57e2d9f99255) [INFO] [stdout] test observe_screenshot_json_contract ... ok [INFO] [stdout] test if_changed_payload_contract ... ok [INFO] [stdout] test observe_screenshot_writes_file_and_prints_path_line ... ok [INFO] [stdout] test observe_screenshot_errors_keep_stdout_empty ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 4 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.02s [INFO] [stdout] [INFO] [stderr] Running tests/preflight.rs (/opt/rustwide/target/debug/deps/preflight-b622705cf34d4ffe) [INFO] [stdout] [INFO] [stdout] running 11 tests [INFO] [stdout] test preflight_missing_cliclick_has_explicit_install_hint ... ok [INFO] [stdout] test preflight::tests::helpers_cover_path_detection_and_sanitization ... ok [INFO] [stdout] test preflight::tests::collect_snapshot_without_osascript_marks_permission_unknown ... ok [INFO] [stdout] test preflight_json_structure_is_deterministic ... ok [INFO] [stdout] test preflight_permissions_schema_ready_is_consistent_with_component_states ... ok [INFO] [stdout] test preflight_text_output_is_deterministic ... ok [INFO] [stdout] test preflight::tests::run_osascript_reports_spawn_failures ... ok [INFO] [stdout] test preflight::tests::probe_input_hotkey_uses_non_esc_key_and_maps_failures ... ok [INFO] [stdout] test preflight::tests::probe_accessibility_covers_success_and_error_modes ... ok [INFO] [stdout] test preflight::tests::collect_snapshot_uses_stubbed_tools ... ok [INFO] [stdout] test preflight::tests::probe_automation_covers_blocked_and_unknown ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 11 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.15s [INFO] [stdout] [INFO] [stderr] Running tests/preflight_probes.rs (/opt/rustwide/target/debug/deps/preflight_probes-2ae1ab16c2668443) [INFO] [stdout] [INFO] [stdout] running 1 test [INFO] [stdout] test preflight_include_probes_adds_probe_rows ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 1 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.03s [INFO] [stdout] [INFO] [stderr] Running tests/profile.rs (/opt/rustwide/target/debug/deps/profile-030443db84b9537a) [INFO] [stdout] [INFO] [stdout] running 3 tests [INFO] [stdout] test profile_validate_reports_actionable_error_for_missing_keys ... ok [INFO] [stdout] test profile_validate_accepts_default_fixture ... ok [INFO] [stdout] test profile_init_writes_scaffold_to_requested_path ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 3 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.01s [INFO] [stdout] [INFO] [stderr] Running tests/real_common.rs (/opt/rustwide/target/debug/deps/real_common-45c5b5232dc588da) [INFO] [stderr] Running tests/retry.rs (/opt/rustwide/target/debug/deps/retry-6edfdd3467520626) [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] [stdout] [INFO] [stdout] running 3 tests [INFO] [stdout] test json_metadata_exposes_retry_and_timeout_policy ... ok [INFO] [stdout] test click_without_retries_fails_on_first_transient_error ... ok [INFO] [stdout] test click_retries_then_succeeds_when_policy_allows ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 3 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.06s [INFO] [stdout] [INFO] [stderr] Running tests/scenario_chain.rs (/opt/rustwide/target/debug/deps/scenario_chain-e2d93f0044aaac08) [INFO] [stdout] [INFO] [stdout] running 5 tests [INFO] [stdout] test scenario_ax_step_supports_gate_and_postcondition_flags ... ok [INFO] [stdout] test scenario_steps_report_ax_path_and_fallback_state ... ok [INFO] [stdout] test scenario_steps_report_ax_native_path_when_fallback_not_used ... ok [INFO] [stdout] test scenario_run_executes_fixture_steps ... ok [INFO] [stdout] test scenario_chain_activate_wait_click_type_and_observe_succeeds ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 5 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.15s [INFO] [stdout] [INFO] [stderr] Running tests/wait.rs (/opt/rustwide/target/debug/deps/wait-f96413c01d1ad5d7) [INFO] [stdout] [INFO] [stdout] running 10 tests [INFO] [stdout] test wait_window_present_succeeds_for_terminal ... ok [INFO] [stdout] test wait_ax_present_reports_matched_count_in_json ... ok [INFO] [stdout] test wait_app_active_succeeds_for_terminal_bundle_id_fixture ... ok [INFO] [stdout] test wait_app_active_succeeds_for_terminal_fixture ... ok [INFO] [stdout] test wait_window_present_rejects_window_title_contains_without_app ... ok [INFO] [stdout] test wait_ax_unique_timeout_reports_last_match_count_hint ... ok [INFO] [stdout] test wait_policy_flags_aliases_work_for_wait_commands ... ok [INFO] [stdout] test wait_sleep_returns_single_result_line ... ok [INFO] [stdout] test wait_json_and_tsv_contracts ... ok [INFO] [stderr] Running tests/window_activate.rs (/opt/rustwide/target/debug/deps/window_activate-a7d017bc5e213e85) [INFO] [stdout] test wait_app_active_timeout_is_runtime_error ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 10 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.06s [INFO] [stdout] [INFO] [stdout] [INFO] [stdout] running 2 tests [INFO] [stdout] test window_activate_error_includes_selector_and_fallback_hint ... ok [INFO] [stderr] Doc-tests macos_agent [INFO] [stdout] test window_activate_json_contains_action_metadata ... ok [INFO] [stdout] [INFO] [stdout] test result: ok. 2 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.03s [INFO] [stdout] [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" "ef98ee0c2acb2ab0bb160513933cd2eff2da763195964a805313eeef91d02f71", kill_on_drop: false }` [INFO] running `Command { std: "docker" "rm" "-f" "ef98ee0c2acb2ab0bb160513933cd2eff2da763195964a805313eeef91d02f71", kill_on_drop: false }` [INFO] [stdout] ef98ee0c2acb2ab0bb160513933cd2eff2da763195964a805313eeef91d02f71