[INFO] cloning repository https://github.com/Nixter77/TUI_bot_RUST
[INFO] running `Command { std: "git" "-c" "credential.helper=" "-c" "credential.helper=/workspace/cargo-home/bin/git-credential-null" "clone" "--bare" "https://github.com/Nixter77/TUI_bot_RUST" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2FNixter77%2FTUI_bot_RUST", kill_on_drop: false }`
[INFO] [stderr] Cloning into bare repository '/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2FNixter77%2FTUI_bot_RUST'...
[INFO] running `Command { std: "git" "rev-parse" "HEAD", kill_on_drop: false }`
[INFO] [stdout] 4ea6d4bfc39dc1921dc16f09e3cdfe877159c7e9
[INFO] testing Nixter77/TUI_bot_RUST against 1.100.0-beta.1 for beta-1.100-2
[INFO] running `Command { std: "git" "clone" "/workspace/cache/git-repos/https%3A%2F%2Fgithub.com%2FNixter77%2FTUI_bot_RUST" "/workspace/builds/worker-1-tc2/source", kill_on_drop: false }`
[INFO] [stderr] Cloning into '/workspace/builds/worker-1-tc2/source'...
[INFO] [stderr] done.
[INFO] started tweaking git repo https://github.com/Nixter77/TUI_bot_RUST
[INFO] finished tweaking git repo https://github.com/Nixter77/TUI_bot_RUST
[INFO] tweaked toml for git repo https://github.com/Nixter77/TUI_bot_RUST written to /workspace/builds/worker-1-tc2/source/Cargo.toml
[INFO] validating manifest of git repo https://github.com/Nixter77/TUI_bot_RUST on toolchain 1.100.0-beta.1
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+1.100.0-beta.1" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }`
[INFO] crate git repo https://github.com/Nixter77/TUI_bot_RUST 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" "+1.100.0-beta.1" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] [stderr]     Blocking waiting for file lock on package cache
[INFO] [stderr]     Blocking waiting for file lock on package cache
[INFO] [stderr]  Downloading crates ...
[INFO] [stderr]   Downloaded uuid v1.25.0
[INFO] [stderr]   Downloaded crossterm v0.28.1
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc2/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-1-tc2/target:/opt/rustwide/target:rw,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" "-m" "1610612736" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:3111399a4047eeb3a02b7a90e478d715f38a8c6669b5c4b49d30a17385265909" "sleep" "infinity", kill_on_drop: false }`
[INFO] [stdout] 3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5
[INFO] running `Command { std: "docker" "start" "3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "exec" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-w" "/opt/rustwide/workdir" "--user" "0:0" "3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5" "/opt/rustwide/cargo-home/bin/cargo" "+1.100.0-beta.1" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "exec" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-w" "/opt/rustwide/workdir" "--user" "0:0" "3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5" "/opt/rustwide/cargo-home/bin/cargo" "+1.100.0-beta.1" "build" "--frozen" "--message-format=json", kill_on_drop: false }`
[INFO] [stderr]    Compiling smallvec v1.15.2
[INFO] [stderr]    Compiling syn v3.0.3
[INFO] [stderr]    Compiling syn v2.0.119
[INFO] [stderr]    Compiling num-traits v0.2.19
[INFO] [stderr]    Compiling signal-hook v0.3.18
[INFO] [stderr]    Compiling getrandom v0.2.17
[INFO] [stderr]    Compiling rustls v0.23.43
[INFO] [stderr]    Compiling rustix v0.38.44
[INFO] [stderr]    Compiling digest v0.10.7
[INFO] [stderr]    Compiling mio v1.2.2
[INFO] [stderr]    Compiling linux-raw-sys v0.4.15
[INFO] [stderr]    Compiling rust_decimal v1.42.1
[INFO] [stderr]    Compiling clap_builder v4.6.6
[INFO] [stderr]    Compiling arrayvec v0.7.8
[INFO] [stderr]    Compiling ring v0.17.14
[INFO] [stderr]    Compiling hmac v0.12.1
[INFO] [stderr]    Compiling sha2 v0.10.9
[INFO] [stderr]    Compiling parking_lot_core v0.9.12
[INFO] [stderr]    Compiling parking_lot v0.12.5
[INFO] [stderr]    Compiling signal-hook-mio v0.2.5
[INFO] [stderr]    Compiling chrono v0.4.45
[INFO] [stderr]    Compiling crossterm v0.28.1
[INFO] [stderr]    Compiling rustls-webpki v0.103.15
[INFO] [stderr]    Compiling synstructure v0.13.2
[INFO] [stderr]    Compiling zerofrom-derive v0.1.7
[INFO] [stderr]    Compiling yoke-derive v0.8.2
[INFO] [stderr]    Compiling zerovec-derive v0.11.6
[INFO] [stderr]    Compiling displaydoc v0.2.7
[INFO] [stderr]    Compiling serde_derive v1.0.229
[INFO] [stderr]    Compiling clap_derive v4.6.4
[INFO] [stderr]    Compiling thiserror-impl v2.0.20
[INFO] [stderr]    Compiling zerofrom v0.1.8
[INFO] [stderr]    Compiling yoke v0.8.3
[INFO] [stderr]    Compiling zerotrie v0.2.5
[INFO] [stderr]    Compiling zerovec v0.11.8
[INFO] [stderr]    Compiling thiserror v2.0.20
[INFO] [stderr]    Compiling clap v4.6.6
[INFO] [stderr]    Compiling tinystr v0.8.4
[INFO] [stderr]    Compiling potential_utf v0.1.6
[INFO] [stderr]    Compiling icu_collections v2.3.0
[INFO] [stderr]    Compiling icu_locale_core v2.3.0
[INFO] [stderr]    Compiling serde v1.0.229
[INFO] [stderr]    Compiling icu_provider v2.3.1
[INFO] [stderr]    Compiling icu_properties v2.3.0
[INFO] [stderr]    Compiling icu_normalizer v2.3.0
[INFO] [stderr]    Compiling idna_adapter v1.2.2
[INFO] [stderr]    Compiling idna v1.1.0
[INFO] [stderr]    Compiling url v2.5.8
[INFO] [stderr]    Compiling ureq v2.12.1
[INFO] [stderr]    Compiling tui-bot v0.1.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `dev` profile [unoptimized + debuginfo] target(s) in 40.34s
[INFO] running `Command { std: "docker" "inspect" "3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "exec" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-w" "/opt/rustwide/workdir" "--user" "0:0" "3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5" "/opt/rustwide/cargo-home/bin/cargo" "+1.100.0-beta.1" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }`
[INFO] [stderr]    Compiling tui-bot v0.1.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 18.88s
[INFO] running `Command { std: "docker" "inspect" "3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "exec" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=warn" "-e" "RUSTDOCFLAGS=--cap-lints=warn" "-w" "/opt/rustwide/workdir" "--user" "0:0" "3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5" "/opt/rustwide/cargo-home/bin/cargo" "+1.100.0-beta.1" "test" "--frozen", kill_on_drop: false }`
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 0.32s
[INFO] [stderr]      Running unittests src/lib.rs (/opt/rustwide/target/debug/build/tui-bot/d5fbf7bebbd87383/out/tui_bot-d5fbf7bebbd87383)
[INFO] [stdout] 
[INFO] [stdout] running 30 tests
[INFO] [stdout] test desk_orchestrator::tests::flag_off_by_default ... ok
[INFO] [stdout] test desk_schedule::tests::full_day_table_no_overlap_ambiguity ... ok
[INFO] [stdout] test desk_schedule::tests::desk_owner_s3_arm_and_s2_gaps ... ok
[INFO] [stdout] test desk_orchestrator::tests::double_book_fail_closed ... ok
[INFO] [stdout] test desk_schedule::tests::may_enter_flag_off_and_on ... ok
[INFO] [stdout] test desk_schedule::tests::desk_owner_s4_wins_0_2 ... ok
[INFO] [stdout] test openmeta::tests::risk_and_r_math ... ok
[INFO] [stdout] test openmeta::tests::garbage_meta_is_rejected ... ok
[INFO] [stdout] test desk_orchestrator::tests::manages_long_desk_sids_only_when_tagged ... ok
[INFO] [stdout] test desk_schedule::tests::s4_windows_match_default_entry_hours ... ok
[INFO] [stdout] test regime::tests::bear_blocks ... ok
[INFO] [stdout] test regime::tests::gate_helpers ... ok
[INFO] [stdout] test desk_orchestrator::tests::owner_reuses_desk_schedule_clock ... ok
[INFO] [stdout] test desk_schedule::tests::s3_arm_22_23_only ... ok
[INFO] [stdout] test desk_orchestrator::tests::status_shows_owner ... ok
[INFO] [stdout] test desk_orchestrator::tests::filter_enter_rejects_double_book ... ok
[INFO] [stdout] test regime::tests::bull_and_strong_bull ... ok
[INFO] [stdout] test openmeta::tests::mfe_mae_update ... ok
[INFO] [stdout] test regime::tests::strong_bull_full_risk ... ok
[INFO] [stdout] test regime::tests::missing_htf_is_neutral_half_risk ... ok
[INFO] [stdout] test regime::tests::neutral_half_risk_recovering ... ok
[INFO] [stdout] test regime::tests::panic_on_sharp_1h_drop ... ok
[INFO] [stdout] test regime::tests::risk_multiplier_table ... ok
[INFO] [stderr]      Running unittests src/main.rs (/opt/rustwide/target/debug/build/tui-bot/5c9c7155a865b636/out/tui_bot-5c9c7155a865b636)
[INFO] [stdout] test desk_orchestrator::tests::manage_stays_on_opening_sid_across_owner_hour ... ok
[INFO] [stdout] test desk_orchestrator::tests::flag_off_leaves_strategy_id_unchanged ... ok
[INFO] [stdout] test desk_orchestrator::tests::heat_desk_and_per_sid ... ok
[INFO] [stdout] test desk_orchestrator::tests::live_short_tail_blocks_orch_enter ... ok
[INFO] [stdout] test openmeta::tests::s5_folds_1h_bar_high_low_into_close_mfe_mae_r ... ok
[INFO] [stdout] test openmeta::tests::continuation_owns_isolates_s4_s5 ... ok
[INFO] [stdout] test desk_orchestrator::tests::orchestrator_owner_switch_changes_strategy_id ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 30 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.05s
[INFO] [stdout] 
[INFO] [stderr]      Running tests/backtest.rs (/opt/rustwide/target/debug/build/tui-bot/50530de2170fe854/out/backtest-50530de2170fe854)
[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 2 tests
[INFO] [stdout] test s5_cached_1h_sim_metric_if_present ... ok
[INFO] [stdout] test strategy4_simulate_bars_emits_pnl_fields ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 2 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.01s
[INFO] [stdout] 
[INFO] [stderr]      Running tests/cli.rs (/opt/rustwide/target/debug/build/tui-bot/ee1f0a8a507de5a3/out/cli-ee1f0a8a507de5a3)
[INFO] [stdout] 
[INFO] [stdout] running 5 tests
[INFO] [stdout] test help_lists_flags ... ok
[INFO] [stdout] test live_without_keys_is_refused ... ok
[INFO] [stdout] test dump_frame_exit_zero_and_surfaces ... ok
[INFO] [stdout] test dump_frame_strategy_5_shows_title ... ok
[INFO] [stdout] test dump_frame_strategy_4_shows_title ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 5 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.03s
[INFO] [stdout] 
[INFO] [stderr]      Running tests/config.rs (/opt/rustwide/target/debug/build/tui-bot/90d2bdf097f21026/out/config-90d2bdf097f21026)
[INFO] [stdout] 
[INFO] [stdout] running 18 tests
[INFO] [stdout] test credentials_debug_redacts_secret ... ok
[INFO] [stdout] test allows_demo_fapi_host ... ok
[INFO] [stdout] test default_base_is_testnet ... ok
[INFO] [stdout] test dotenv_parser_ignores_junk ... ok
[INFO] [stdout] test poll_allowed_values ... ok
[INFO] [stdout] test env_flag_on_accepts_known_tokens ... ok
[INFO] [stdout] test refuses_non_allowlisted_https_host ... ok
[INFO] [stdout] test missing_keys_watch_ok_live_refused ... ok
[INFO] [stdout] test reads_keys_from_environ_only ... ok
[INFO] [stdout] test refuses_mainnet_without_override ... ok
[INFO] [stdout] test entry_hours_default_and_always_enter ... ok
[INFO] [stdout] test telegram_optional_and_paired ... ok
[INFO] [stdout] test rejects_bad_poll_and_http_base ... ok
[INFO] [stdout] test leverage_and_notional_options ... ok
[INFO] [stdout] test risk_pct_from_env_zero_is_off ... ok
[INFO] [stdout] test strategy2_entry_hours_and_max_hold_from_env ... ok
[INFO] [stdout] test strategy4_interval_from_env ... ok
[INFO] [stdout] test daily_loss_r_from_env ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 18 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.00s
[INFO] [stdout] 
[INFO] [stderr]      Running tests/dayrisk.rs (/opt/rustwide/target/debug/build/tui-bot/dccb147d15566742/out/dayrisk-dccb147d15566742)
[INFO] [stdout] 
[INFO] [stdout] running 8 tests
[INFO] [stdout] test defaults_match_config_story ... ok
[INFO] [stdout] test one_r_is_start_equity_times_risk_pct ... ok
[INFO] [stdout] test usdt_still_trips_even_when_r_budget_is_larger ... ok
[INFO] [stderr]      Running tests/engine.rs (/opt/rustwide/target/debug/build/tui-bot/314a9d21b7c27618/out/engine-314a9d21b7c27618)
[INFO] [stdout] test r_halt_trips_independently_when_usdt_budget_huge ... ok
[INFO] [stdout] test r_halt_off_when_limit_r_or_risk_pct_zero ... ok
[INFO] [stdout] test usdt_halt_does_not_trip_inside_budget ... ok
[INFO] [stdout] test usdt_halt_trips_when_pnl_hits_budget ... ok
[INFO] [stdout] test either_layer_latches_halt_until_next_utc_day ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 8 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.01s
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] running 156 tests
[INFO] [stdout] test coalesce_does_not_resurrect_when_live_is_none ... ok
[INFO] [stdout] test does_not_rescan_before_poll ... ok
[INFO] [stdout] test daily_loss_r_halt_keeps_manage_trail ... ok
[INFO] [stdout] test does_not_chase_already_pumped_over_12pct ... ok
[INFO] [stdout] test coalesce_overlay_does_not_lower_live_stop ... ok
[INFO] [stdout] test daily_loss_r_halt_trips_independently ... ok
[INFO] [stdout] test enters_leading_major_even_near_24h_high ... ok
[INFO] [stdout] test bad_poll_seconds_is_hold_not_panic ... ok
[INFO] [stdout] test leftover_short_blocks_new_entries ... ok
[INFO] [stdout] test daily_loss_r_halt_blocks_enter_independent_of_usdt ... ok
[INFO] [stdout] test default_is_one_slot ... ok
[INFO] [stdout] test daily_loss_usdt_halt_still_trips_via_equity ... ok
[INFO] [stdout] test missing_stop_attaches_from_entry_not_mark ... ok
[INFO] [stdout] test poll_timeout_is_not_sticky ... ok
[INFO] [stdout] test entry_inflight_blocks_second_buy ... ok
[INFO] [stdout] test live_book_keeps_inflight_and_does_not_repeat_enter ... ok
[INFO] [stdout] test daily_usdt_halt_trips_from_equity_pnl ... ok
[INFO] [stdout] test manages_three_open_longs_independently ... ok
[INFO] [stdout] test poll_is_one_or_two_minutes ... ok
[INFO] [stdout] test holds_open_long_on_red_5m_above_stop ... ok
[INFO] [stdout] test holds_when_name_drops_off_the_growth_book ... ok
[INFO] [stdout] test red_slot_does_not_open_another ... ok
[INFO] [stdout] test retry_until_blocks_new_enter ... ok
[INFO] [stdout] test reduce_long_decision_latches_scaled_without_apply ... ok
[INFO] [stdout] test s1_allows_24h_between_2_and_4 ... ok
[INFO] [stdout] test s1_weak_3d_does_not_block ... ok
[INFO] [stdout] test retry_timeout_stays_in_footer_during_backoff ... ok
[INFO] [stdout] test s1_skips_major_when_4h_below_ema20 ... ok
[INFO] [stdout] test s1_skips_late_chase_without_1h_confirm ... ok
[INFO] [stdout] test red_5m_skips_enter ... ok
[INFO] [stdout] test s3_manages_tradable_alts_junk_is_tail ... ok
[INFO] [stdout] test s3_blocks_new_entry_when_btc_is_bear ... ok
[INFO] [stdout] test s3_open_alt_is_managed_not_tail ... ok
[INFO] [stdout] test scan_can_enter_three_rising_names ... ok
[INFO] [stdout] test short_position_is_not_managed_as_long ... ok
[INFO] [stdout] test s3_skips_when_live_price_ran_away_from_close ... ok
[INFO] [stdout] test skip_no_htf_trend_only_requires_close_above_ema20 ... ok
[INFO] [stdout] test s3_does_not_chase_hours_after_daily_close ... ok
[INFO] [stdout] test scan_buys_most_rising_with_tp_and_sl ... ok
[INFO] [stdout] test s3_junk_open_is_tail ... ok
[INFO] [stdout] test s3_picks_least_extended_breakout_not_volume ... ok
[INFO] [stdout] test skip_no_uptrend_hour1_requires_ema20_rising ... ok
[INFO] [stdout] test strategy4_banks_at_1_5r_while_still_pre_be ... ok
[INFO] [stdout] test skip_no_uptrend_only_requires_close_above_ema20 ... ok
[INFO] [stdout] test skips_new_entries_outside_start_hours_but_trails_open_long ... ok
[INFO] [stdout] test skips_tradfi_names_and_keeps_skip_list ... ok
[INFO] [stdout] test strategy4_15m_interval_names_the_skip ... ok
[INFO] [stdout] test strategy4_banks_at_1_5r_after_be ... ok
[INFO] [stdout] test strategy4_default_s4_max_positions_is_three ... ok
[INFO] [stdout] test strategy4_does_not_chase_green_5m_without_pullback ... ok
[INFO] [stdout] test strategy4_does_not_chase_24h_stretch ... ok
[INFO] [stdout] test strategy4_book_uses_liquid_n_not_max_plus_four ... ok
[INFO] [stdout] test strategy4_can_enter_three_liquid_names ... ok
[INFO] [stdout] test strategy4_does_not_move_stop_before_one_r ... ok
[INFO] [stdout] test strategy4_excludes_majors_from_liquid_universe ... ok
[INFO] [stdout] test strategy4_existing_stop_does_not_move_down ... ok
[INFO] [stdout] test strategy4_15m_stop_and_tp_are_wider_than_five_minute ... ok
[INFO] [stdout] test strategy4_enters_in_recommended_utc_windows ... ok
[INFO] [stdout] test strategy4_always_enter_knob_opens_dead_hours ... ok
[INFO] [stdout] test strategy4_does_not_inherit_strategy1_always_enter ... ok
[INFO] [stdout] test strategy4_exits_when_mark_hits_placed_stop ... ok
[INFO] [stdout] test strategy4_enters_green_day_off_the_24h_high ... ok
[INFO] [stdout] test strategy4_does_not_rebuy_loser_after_desk_pause ... ok
[INFO] [stdout] test strategy4_exits_when_4h_closes_below_ema20 ... ok
[INFO] [stdout] test strategy4_holds_former_leader_until_stop ... ok
[INFO] [stdout] test strategy4_holds_open_long_on_red_5m_above_stop ... ok
[INFO] [stdout] test strategy4_holds_through_missing_4h_while_above_stop ... ok
[INFO] [stdout] test strategy4_mark_trail_raises_sl_tighter_than_bar_low ... ok
[INFO] [stdout] test strategy4_locks_be_from_unrealized_pnl_even_if_last_is_shy ... ok
[INFO] [stdout] test strategy4_locks_be_if_post_entry_bar_high_hit_one_r ... ok
[INFO] [stdout] test strategy4_missing_4h_bars_does_not_enter ... ok
[INFO] [stdout] test strategy4_liquid_continuation_enters ... ok
[INFO] [stdout] test strategy4_missing_5m_bar_does_not_enter ... ok
[INFO] [stdout] test strategy4_missing_universe_bars_does_not_enter ... ok
[INFO] [stdout] test strategy4_moves_stop_to_breakeven_at_one_r ... ok
[INFO] [stdout] test strategy4_outside_session_does_not_enter_when_always_enter_off ... ok
[INFO] [stdout] test strategy4_htf_allows_entry_without_4h_higher_low_if_close_above_ema20 ... ok
[INFO] [stdout] test strategy4_post_be_1_5r_exits_when_mark_below_lock ... ok
[INFO] [stdout] test strategy4_illiquid_weekly_leader_is_not_chased ... ok
[INFO] [stdout] test strategy4_pre_1r_peak_pullback_exits ... ok
[INFO] [stdout] test strategy4_post_scale_15r_exits_remainder ... ok
[INFO] [stdout] test strategy4_prefers_liquid_volume_over_hottest_percent ... ok
[INFO] [stdout] test strategy4_scaled_one_r_latches_reduce ... ok
[INFO] [stdout] test strategy4_ready_setup_is_attempted_on_scan_due ... ok
[INFO] [stdout] test strategy4_reduce_at_1r_latches_once_after_be ... ok
[INFO] [stdout] test strategy4_scaled_latch_blocks_second_reduce ... ok
[INFO] [stdout] test strategy4_post_be_1_5r_locks_half_r_after_giveback ... ok
[INFO] [stdout] test strategy4_skips_bounce_in_one_hour_downtrend ... ok
[INFO] [stdout] test strategy4_second_slot_opens_while_first_not_green ... ok
[INFO] [stdout] test strategy4_seeded_cooldown_blocks_super_rebuy ... ok
[INFO] [stdout] test strategy4_skips_penny_mbox ... ok
[INFO] [stdout] test strategy4_session_end_exits_open_long_outside_window ... ok
[INFO] [stdout] test strategy4_skips_24h_dump_with_5m_pullback ... ok
[INFO] [stdout] test strategy4_skips_15m_pullback_in_4h_downtrend ... ok
[INFO] [stdout] test strategy4_time_stop_exits_after_four_hours ... ok
[INFO] [stdout] test strategy4_trails_on_5m_low_after_breakeven ... ok
[INFO] [stdout] test strategy4_missing_stop_attaches_from_entry_not_mark ... ok
[INFO] [stdout] test strategy4_stop_is_at_least_one_and_a_half_percent ... ok
[INFO] [stdout] test strategy4_skips_weak_24h_change ... ok
[INFO] [stdout] test strategy4_slots_ignore_strategy1_max_positions ... ok
[INFO] [stdout] test strategy4_skips_thin_alts_and_pennies ... ok
[INFO] [stdout] test strategy4_vvv_bar_high_without_opened_bar_time_locks_1r ... ok
[INFO] [stdout] test strategy4_vanish_with_inflight_cools_and_does_not_rebuy ... ok
[INFO] [stdout] test strategy5_adopt_keeps_opened_bar_time_so_1r_scan_is_not_the_book ... ok
[INFO] [stdout] test strategy4_vvv_dump_after_1r_exits_instead_of_waiting ... ok
[INFO] [stdout] test strategy4_vvv_peak_upnl_locks_1r ... ok
[INFO] [stdout] test strategy5_adopt_does_not_hour1_trail_inherited_s4 ... ok
[INFO] [stdout] test strategy5_1h_atr_stop_fits_hour1_band ... ok
[INFO] [stdout] test strategy4_win_vanish_allows_next_liquid ... ok
[INFO] [stdout] test strategy5_1r_not_in_hand_does_not_flatten_or_scale ... ok
[INFO] [stdout] test strategy5_allows_4pct_off_24h_high_s4_skips ... ok
[INFO] [stdout] test strategy5_chart_spec_is_1h ... ok
[INFO] [stdout] test strategy5_does_not_bank_at_1_5r_before_2r ... ok
[INFO] [stdout] test retry_timeout_clears_from_footer_after_backoff ... ok
[INFO] [stdout] test strategy5_caps_same_1h_move_at_two ... ok
[INFO] [stdout] test strategy5_does_not_time_stop_at_four_hours ... ok
[INFO] [stdout] test strategy5_does_not_trail_closed_low_before_be ... ok
[INFO] [stdout] test scalp_leaves_dead_btc_for_eth_setup ... ok
[INFO] [stdout] test strategy5_daily_halt_blocks_enter_keeps_trail ... ok
[INFO] [stdout] test strategy5_daily_loss_usdt_trips_halt ... ok
[INFO] [stdout] test strategy5_enters_in_session_windows_when_s4_is_24_7 ... ok
[INFO] [stdout] test strategy5_does_not_be_at_half_r ... ok
[INFO] [stdout] test strategy5_ignores_stale_1h_history_as_one_r ... ok
[INFO] [stdout] test strategy5_does_not_enter_on_forming_1h_bar ... ok
[INFO] [stdout] test strategy5_does_not_inherit_s4_scan_or_cooldowns ... ok
[INFO] [stdout] test strategy5_enter_path_shares_continuation_core ... ok
[INFO] [stdout] test strategy5_does_not_time_stop_at_eleven_hours ... ok
[INFO] [stdout] test strategy5_loss_cools_symbol_twelve_hours ... ok
[INFO] [stdout] test strategy5_full_position_be_at_one_r_no_scale_out ... ok
[INFO] [stdout] test daily_halt_blocks_enter_keeps_trail ... ok
[INFO] [stdout] test strategy5_missing_4h_bars_does_not_enter ... ok
[INFO] [stdout] test s1_tp_is_at_least_two_r ... ok
[INFO] [stdout] test strategy5_inherits_s4_always_enter ... ok
[INFO] [stdout] test s1_treats_leftover_alt_as_tail ... ok
[INFO] [stdout] test strategy5_slot_cap_honors_one ... ok
[INFO] [stdout] test strategy5_skips_live_privacy_cluster ... ok
[INFO] [stdout] test strategy5_uses_hour1_stop_band ... ok
[INFO] [stdout] test strategy5_verify_name_and_1h_interval ... ok
[INFO] [stdout] test strategy5_pullback_resume_ignores_forming_wick ... ok
[INFO] [stdout] test strategy5_trails_once_per_closed_1h_bar ... ok
[INFO] [stdout] test strategy5_session_end_does_not_flatten_open_long ... ok
[INFO] [stdout] test strategy5_skips_1h_pullback_in_4h_downtrend ... ok
[INFO] [stdout] test strategy5_skips_mid_volume_name_s4_still_takes ... ok
[INFO] [stdout] test tick_and_three_named_strategies ... ok
[INFO] [stdout] test trails_stop_up_and_never_down ... ok
[INFO] [stdout] test strategy5_skips_first_three_minutes_of_hour ... ok
[INFO] [stdout] test strategy5_trails_1h_bar_low_not_mark_pct ... ok
[INFO] [stdout] test strategy5_stale_peak_does_not_flatten_pullback ... ok
[INFO] [stdout] test strategy5_time_stop_after_twelve_hours ... ok
[INFO] [stdout] test trend_enters_alt_breakout_not_only_majors ... ok
[INFO] [stdout] test trend_leaves_dead_btc_for_eth_breakout ... ok
[INFO] [stdout] test two_red_slots_block_third_major ... ok
[INFO] [stdout] test scan_buys_fastest_major_not_alt_junk ... ok
[INFO] [stdout] test strategy4_does_not_be_at_half_r ... ok
[INFO] [stdout] test strategy4_desk_pause_after_stop_does_not_fill_next_alt ... ok
[INFO] [stdout] test cooldown_after_position_vanishes ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 156 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.11s
[INFO] [stdout] 
[INFO] [stderr]      Running tests/errorlog.rs (/opt/rustwide/target/debug/build/tui-bot/1f23979a3038c227/out/errorlog-1f23979a3038c227)
[INFO] [stdout] 
[INFO] [stdout] running 7 tests
[INFO] [stdout] test extract_code_from_json_and_http ... ok
[INFO] [stdout] test order_symbol_rejects_query_injection ... ok
[INFO] [stdout] test describe_does_not_panic_on_multibyte_truncation ... ok
[INFO] [stdout] test observe_writes_shown_still_and_cleared ... ok
[INFO] [stdout] test redact_strips_api_key_header ... ok
[INFO] [stdout] test redact_strips_signature_from_transport_errors ... ok
[INFO] [stdout] test redact_strips_telegram_bot_token ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 7 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.10s
[INFO] [stdout] 
[INFO] [stderr]      Running tests/flatten.rs (/opt/rustwide/target/debug/build/tui-bot/e43e2f8a6d21b450/out/flatten-e43e2f8a6d21b450)
[INFO] [stdout] 
[INFO] [stdout] running 10 tests
[INFO] [stdout] test continues_after_one_symbol_fails ... ok
[INFO] [stdout] test close_cancels_protectives_again_after_fill ... ok
[INFO] [stdout] test flatten_open_book_confirm_read_failure_is_error ... ok
[INFO] [stdout] test long_sells_short_buys_and_cancels ... ok
[INFO] [stdout] test paused_tick_does_not_enter ... ok
[INFO] [stdout] test flatten_open_book_reports_leftover ... ok
[INFO] [stdout] test no_credentials_refuses ... ok
[INFO] [stdout] test skips_zero_qty_and_keeps_shorts ... ok
[INFO] [stdout] test watch_mode_sends_nothing ... ok
[INFO] [stdout] test paused_tick_resumes_after_cooldown ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 10 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.01s
[INFO] [stdout] 
[INFO] [stderr]      Running tests/indicators.rs (/opt/rustwide/target/debug/build/tui-bot/85bc479d5655003b/out/indicators-85bc479d5655003b)
[INFO] [stdout] 
[INFO] [stdout] running 2 tests
[INFO] [stdout] test ema20_needs_twenty_closes ... ok
[INFO] [stdout] test last_two_swing_lows_need_higher_second ... 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] [stderr]      Running tests/journal.rs (/opt/rustwide/target/debug/build/tui-bot/651778197d932816/out/journal-651778197d932816)
[INFO] [stdout] 
[INFO] [stdout] running 21 tests
[INFO] [stdout] test scratch_above_entry_is_not_a_win_after_fees ... ok
[INFO] [stdout] test long_pnl_subtracts_taker_both_sides ... ok
[INFO] [stdout] test trade_event_old_line_still_parses ... ok
[INFO] [stdout] test losing_close_keeps_whole_desk_paused ... ok
[INFO] [stdout] test london_window_ends_at_ten_utc ... ok
[INFO] [stdout] test take_profit_net_stays_green_after_fees ... ok
[INFO] [stdout] test trade_event_parses_phase1_r_fields ... ok
[INFO] [stdout] test journal_symbol_strips_side_prefix ... ok
[INFO] [stdout] test journal_file_is_owner_only ... ok
[INFO] [stdout] test unmatched_opens_apply_later_amend_stop ... ok
[INFO] [stdout] test unmatched_partial_close_keeps_remainder_and_later_be ... ok
[INFO] [stdout] test unmatched_opens_keep_sl_until_close ... ok
[INFO] [stdout] test recent_closes_seed_cooldown_so_restart_does_not_rebuy ... ok
[INFO] [stdout] test s5_losing_close_cools_twelve_hours ... ok
[INFO] [stdout] test losing_close_keeps_symbol_off_book_for_twelve_hours ... ok
[INFO] [stdout] test open_meta_r_math_and_persist_roundtrip ... ok
[INFO] [stdout] test close_tags_opener_strategy_id_not_running_lens ... ok
[INFO] [stdout] test parallel_appends_do_not_tear_jsonl_lines ... ok
[INFO] [stdout] test s5_close_persists_mfe_mae_r_from_1h_bars ... ok
[INFO] [stderr]      Running tests/keys.rs (/opt/rustwide/target/debug/build/tui-bot/b36e2bb917e46296/out/keys-b36e2bb917e46296)
[INFO] [stdout] test unmatched_reads_active_path_not_default ... ok
[INFO] [stdout] test unmatched_without_active_journal_is_empty ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 21 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.06s
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] running 4 tests
[INFO] [stdout] test snapshot_due_is_elapsed_time_not_key_silence ... ok
[INFO] [stdout] test snapshot_stale_after_thirty_seconds ... ok
[INFO] [stdout] test flatten_is_x_then_x_other_cancels ... ok
[INFO] [stdout] test keys_bind_strategy_refresh_quit ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 4 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.00s
[INFO] [stdout] 
[INFO] [stderr]      Running tests/live.rs (/opt/rustwide/target/debug/build/tui-bot/403a499af58adfcf/out/live-403a499af58adfcf)
[INFO] [stdout] 
[INFO] [stdout] running 85 tests
[INFO] [stdout] test already_flat_close_error_is_narrow ... ok
[INFO] [stdout] test amend_be_failure_flattens_long ... ok
[INFO] [stdout] test classify_2021_is_retry_not_keep ... ok
[INFO] [stdout] test buy_client_order_id_is_binance_safe ... ok
[INFO] [stdout] test daily_halt_refuses_buy ... ok
[INFO] [stdout] test exchange_min_notional_mode_uses_btc_min ... ok
[INFO] [stdout] test close_position_4130_without_sized_pair_flattens ... ok
[INFO] [stdout] test exit_uses_shared_market_close ... ok
[INFO] [stdout] test algo_orders_send_conditional_algo_type ... ok
[INFO] [stdout] test fixed_notional_below_btc_min_skips_instead_of_upsizing ... ok
[INFO] [stdout] test amend_2021_fail_closed_flattens_no_storm ... ok
[INFO] [stdout] test buy_timeout_after_fill_still_places_protectives ... ok
[INFO] [stdout] test amend_error_clears_sized_stops_so_rearm_can_run ... ok
[INFO] [stdout] test enter_without_position_risk_does_not_buy ... ok
[INFO] [stdout] test hour1_flatten_does_not_leave_orphan_sell ... ok
[INFO] [stdout] test amend_without_live_long_flattens_leftover_short ... ok
[INFO] [stdout] test buy_client_order_id_is_stable_inside_retry_bucket ... ok
[INFO] [stdout] test exit_when_live_book_already_flat_does_not_journal_close ... ok
[INFO] [stdout] test no_credentials_refuses ... ok
[INFO] [stdout] test orphan_fallback_probes_when_global_lists_fail ... ok
[INFO] [stdout] test fixed_notional_below_exchange_minimum_skips_instead_of_upsizing ... ok
[INFO] [stdout] test fill_then_protect_failure_flattens_naked ... ok
[INFO] [stdout] test amend_success_writes_stop_into_state ... ok
[INFO] [stdout] test market_close_params_always_reduce_only_sell_for_long ... ok
[INFO] [stdout] test orphan_cleanup_does_not_probe_majors_when_global_list_works ... ok
[INFO] [stdout] test close_position_4130_with_sized_pair_counts_as_armed ... ok
[INFO] [stdout] test live_tui_loop_fills_three_majors_not_alts ... ok
[INFO] [stdout] test live_reduce_latches_before_ack_and_second_tick_no_re_reduce ... ok
[INFO] [stdout] test minus_2022_retries_naked_close_only_when_book_still_open ... ok
[INFO] [stdout] test live_entry_rebases_protection_and_accounting_to_confirmed_fill ... ok
[INFO] [stdout] test live_tui_loop_fills_three_majors_then_refuses_fourth ... ok
[INFO] [stdout] test paper_reduce_long_halves_qty_sets_be_and_latch ... ok
[INFO] [stdout] test parse_open_order_rows_accepts_wrapped_object ... ok
[INFO] [stdout] test prune_keeps_matching_tp_and_drops_old_stop ... ok
[INFO] [stdout] test rearm_replaces_when_algo_list_errors ... ok
[INFO] [stdout] test rearm_replaces_when_sized_stops_lie_and_algos_are_gone ... ok
[INFO] [stdout] test rearm_skips_when_sized_protectives_are_on_the_book ... ok
[INFO] [stdout] test orphan_stop_on_live_long_is_left_for_rearm ... ok
[INFO] [stdout] test reconcile_does_not_freeze_desk_after_short_sweep ... ok
[INFO] [stdout] test protectives_are_reduce_only_sized_not_close_position ... ok
[INFO] [stdout] test reduce_be_amend_retries_once_then_flattens_and_keeps_latch ... ok
[INFO] [stdout] test rearm_2021_fail_closed_immediate ... ok
[INFO] [stdout] test rearm_flattens_after_three_failed_attempts ... ok
[INFO] [stdout] test orphan_stop_on_flat_symbol_is_cancelled_after_restart ... ok
[INFO] [stdout] test paper_path_after_1r_tick_halves_and_be ... ok
[INFO] [stdout] test reduce_long_full_qty_falls_through_to_be_amend_and_latches ... ok
[INFO] [stdout] test reduce_remain_below_min_qty_falls_through_to_be_only ... ok
[INFO] [stdout] test reduce_qty_273_5_quantized_to_step_avoids_precision ... ok
[INFO] [stdout] test reduce_live_sizes_to_live_long_not_stale_state ... ok
[INFO] [stdout] test replace_stop_places_before_cancelling_old_pair ... ok
[INFO] [stdout] test s1_rearm_skips_leftover_alt ... ok
[INFO] [stdout] test risk_pct_notional_is_equity_times_pct_over_stop_distance ... ok
[INFO] [stdout] test reduce_long_closes_half_and_amends_be_remainder ... ok
[INFO] [stdout] test risk_size_btc_min_does_not_bump_past_risk ... ok
[INFO] [stdout] test risk_size_skips_when_min_notional_would_inflate_risk ... ok
[INFO] [stdout] test s1_sweep_closes_leftover_alt_long ... ok
[INFO] [stdout] test s4_live_risk_pct_zero_below_min_skips_instead_of_upsizing ... ok
[INFO] [stdout] test s4_live_risk_pct_fills_387_and_does_not_bump ... ok
[INFO] [stdout] test s4_live_risk_pct_zero_falls_back_to_order_notional ... ok
[INFO] [stdout] test s4_live_skips_symbol_when_min_notional_inflates_risk ... ok
[INFO] [stdout] test s5_amend_without_stored_tp_uses_2r_not_cfg_tp_pct ... ok
[INFO] [stdout] test paper_reduce_then_tick_does_not_re_reduce ... ok
[INFO] [stdout] test s5_daily_halt_refuses_buy ... ok
[INFO] [stdout] test s5_rearm_keeps_remembered_stop_and_fills_2r_tp ... ok
[INFO] [stdout] test s5_rearm_without_stored_protectives_uses_2r_not_cfg_tp_pct ... ok
[INFO] [stdout] test live_tui_loop_strategy4_fills_three_liquid ... ok
[INFO] [stdout] test skip_enter_when_already_in_position ... ok
[INFO] [stdout] test skip_enter_when_live_book_has_long_but_snapshot_is_flat ... ok
[INFO] [stdout] test sell_without_reduce_only_params_rejected_by_builder ... ok
[INFO] [stdout] test stale_sell_protective_detects_old_stop ... ok
[INFO] [stdout] test sets_leverage_only_when_configured ... ok
[INFO] [stdout] test size_market_order_uses_shipped_formula ... ok
[INFO] [stdout] test sweep_closes_leftover_short_and_cools_symbol ... ok
[INFO] [stdout] test sweep_short_cancels_leftover_sell ... ok
[INFO] [stdout] test watch_mode_sends_nothing ... ok
[INFO] [stdout] test vanished_long_not_cleared_when_live_long_remains ... ok
[INFO] [stdout] test trail_that_opens_a_short_is_flattened ... ok
[INFO] [stdout] test transport_timeout_on_enter_sets_retry_backoff ... ok
[INFO] [stdout] test vanished_long_cancels_leftover_protectives ... ok
[INFO] [stdout] test vanished_long_cools_even_when_inflight ... ok
[INFO] [stdout] test reconcile_cleans_orphan_stop_without_freezing_entries ... ok
[INFO] [stdout] test amend_without_stored_tp_uses_entry_take_profit ... ok
[INFO] [stdout] test buy_error_without_fill_does_not_place_protectives ... ok
[INFO] [stdout] test rearm_does_not_flatten_before_budget ... ok
[INFO] [stdout] test rearm_flattens_after_fail_budget_exhausted ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 85 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.10s
[INFO] [stdout] 
[INFO] [stderr]      Running tests/monitor.rs (/opt/rustwide/target/debug/build/tui-bot/796835e9ef55e2e6/out/monitor-796835e9ef55e2e6)
[INFO] [stdout] 
[INFO] [stdout] running 10 tests
[INFO] [stdout] test help_and_parse_monitor_flag ... ok
[INFO] [stdout] test s2_in_session_counts_down_to_next_5m_close ... ok
[INFO] [stdout] test s2_wait_heading_is_majors_book_not_24h_tape ... ok
[INFO] [stdout] test s2_outside_hours_until_is_next_session_not_candle ... ok
[INFO] [stdout] test s1_wait_lists_book_not_held ... ok
[INFO] [stdout] test dump_monitor_exit_zero_and_surfaces ... ok
[INFO] [stdout] test wait_until_entry_shows_cooldown ... ok
[INFO] [stdout] test waiting_and_growth_and_pnl ... ok
[INFO] [stderr]      Running tests/pidlock.rs (/opt/rustwide/target/debug/build/tui-bot/739840f365e29b0e/out/pidlock-739840f365e29b0e)
[INFO] [stdout] test monitor_plus_live_without_keys_is_watch ... ok
[INFO] [stdout] test s3_wait_lists_liquid_alts_not_only_majors ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 10 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.04s
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] running 2 tests
[INFO] [stdout] test second_acquire_fails_while_first_is_held ... ok
[INFO] [stdout] test stale_lock_from_dead_pid_is_stolen ... FAILED
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout] 
[INFO] [stdout] ---- stale_lock_from_dead_pid_is_stolen stdout ----
[INFO] [stdout] 
[INFO] [stdout] thread 'stale_lock_from_dead_pid_is_stolen' (2121) panicked at tests/pidlock.rs:23:36:
[INFO] [stdout] pid 1 is not alive: Custom { kind: AlreadyExists, error: "уже запущен другой --live (pid 1). Сначала q в том TUI." }
[INFO] [stdout] stack backtrace:
[INFO] [stdout]    0:     0x5c095b99d6f1 - std[617be2ca0a6fd877]::backtrace_rs::backtrace::libunwind::trace
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/../../backtrace/src/backtrace/libunwind.rs:117:9
[INFO] [stdout]    1:     0x5c095b99d6f1 - std[617be2ca0a6fd877]::backtrace_rs::backtrace::trace_unsynchronized::<std[617be2ca0a6fd877]::sys::backtrace::_print_fmt::{closure#1}>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/../../backtrace/src/backtrace/mod.rs:66:14
[INFO] [stdout]    2:     0x5c095b99d6f1 - std[617be2ca0a6fd877]::sys::backtrace::_print_fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:74:9
[INFO] [stdout]    3:     0x5c095b99d6f1 - <<std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print::DisplayBacktrace as core[a373ad73a504971]::fmt::Display>::fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:44:26
[INFO] [stdout]    4:     0x5c095b9b1b0a - <core[a373ad73a504971]::fmt::rt::Argument>::fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/fmt/rt.rs:152:76
[INFO] [stdout]    5:     0x5c095b9b1b0a - core[a373ad73a504971]::fmt::write
[INFO] [stdout]    6:     0x5c095b9a1b6c - core[a373ad73a504971]::io::write::default_write_fmt::<alloc[2e1b2a31b91974c5]::vec::Vec<u8>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/io/write.rs:402:11
[INFO] [stdout]    7:     0x5c095b9a1b6c - <alloc[2e1b2a31b91974c5]::vec::Vec<u8> as core[a373ad73a504971]::io::write::Write>::write_fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/io/write.rs:335:13
[INFO] [stdout]    8:     0x5c095b977d56 - <std[617be2ca0a6fd877]::sys::backtrace::BacktraceLock>::print
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:47:9
[INFO] [stdout]    9:     0x5c095b977d56 - std[617be2ca0a6fd877]::panicking::default_hook::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:289:27
[INFO] [stdout]   10:     0x5c095b994f09 - std[617be2ca0a6fd877]::panicking::default_hook
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:313:9
[INFO] [stdout]   11:     0x5c095b925310 - <alloc[2e1b2a31b91974c5]::boxed::Box<dyn for<'a, 'b> core[a373ad73a504971]::ops::function::Fn<(&'a std[617be2ca0a6fd877]::panic::PanicHookInfo<'b>,), Output = ()> + core[a373ad73a504971]::marker::Sync + core[a373ad73a504971]::marker::Send> as core[a373ad73a504971]::ops::function::Fn<(&std[617be2ca0a6fd877]::panic::PanicHookInfo,)>>::call
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/alloc/src/boxed.rs:2328:9
[INFO] [stdout]   12:     0x5c095b925310 - test[aada8e7e76ba119b]::test_main_inner::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:137:21
[INFO] [stdout]   13:     0x5c095b9950c2 - <alloc[2e1b2a31b91974c5]::boxed::Box<dyn for<'a, 'b> core[a373ad73a504971]::ops::function::Fn<(&'a std[617be2ca0a6fd877]::panic::PanicHookInfo<'b>,), Output = ()> + core[a373ad73a504971]::marker::Sync + core[a373ad73a504971]::marker::Send> as core[a373ad73a504971]::ops::function::Fn<(&std[617be2ca0a6fd877]::panic::PanicHookInfo,)>>::call
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/alloc/src/boxed.rs:2328:9
[INFO] [stdout]   14:     0x5c095b9950c2 - std[617be2ca0a6fd877]::panicking::panic_with_hook
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:819:13
[INFO] [stdout]   15:     0x5c095b977e02 - std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:685:13
[INFO] [stdout]   16:     0x5c095b970869 - std[617be2ca0a6fd877]::sys::backtrace::__rust_end_short_backtrace::<std[617be2ca0a6fd877]::panicking::panic_handler::{closure#0}, !>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:182:18
[INFO] [stdout]   17:     0x5c095b978acd - __rustc[ea4f61d10b84890b]::rust_begin_unwind
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:676:5
[INFO] [stdout]   18:     0x5c095b9b22dc - core[a373ad73a504971]::panicking::panic_fmt
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panicking.rs:80:14
[INFO] [stdout]   19:     0x5c095b9b2052 - core[a373ad73a504971]::result::unwrap_failed
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/result.rs:1870:5
[INFO] [stdout]   20:     0x5c095b90db73 - <core[a373ad73a504971]::result::Result<tui_bot[411e8609effcdd69]::pidlock::LiveLock, core[a373ad73a504971]::io::error::Error>>::expect
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/result.rs:1184:23
[INFO] [stdout]   21:     0x5c095b90d3ee - pidlock[ac78282f8bc905ac]::stale_lock_from_dead_pid_is_stolen
[INFO] [stdout]                                at /opt/rustwide/workdir/tests/pidlock.rs:23:36
[INFO] [stdout]   22:     0x5c095b90d0b7 - pidlock[ac78282f8bc905ac]::stale_lock_from_dead_pid_is_stolen::{closure#0}
[INFO] [stdout]                                at /opt/rustwide/workdir/tests/pidlock.rs:19:40
[INFO] [stdout]   23:     0x5c095b90e576 - <pidlock[ac78282f8bc905ac]::stale_lock_from_dead_pid_is_stolen::{closure#0} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   24:     0x5c095b91875b - <fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String> as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   25:     0x5c095b91875b - test[aada8e7e76ba119b]::__rust_begin_short_backtrace::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, fn() -> core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:701:18
[INFO] [stdout]   26:     0x5c095b925935 - test[aada8e7e76ba119b]::run_test_in_process::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:724:74
[INFO] [stdout]   27:     0x5c095b925935 - <core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<test[aada8e7e76ba119b]::run_test_in_process::{closure#0}> as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   28:     0x5c095b925935 - std[617be2ca0a6fd877]::panicking::catch_unwind::do_call::<core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<test[aada8e7e76ba119b]::run_test_in_process::{closure#0}>, core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:573:43
[INFO] [stdout]   29:     0x5c095b925935 - std[617be2ca0a6fd877]::panicking::catch_unwind::<core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>, core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<test[aada8e7e76ba119b]::run_test_in_process::{closure#0}>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:541:19
[INFO] [stdout]   30:     0x5c095b925935 - std[617be2ca0a6fd877]::panic::catch_unwind::<core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<test[aada8e7e76ba119b]::run_test_in_process::{closure#0}>, core[a373ad73a504971]::result::Result<(), alloc[2e1b2a31b91974c5]::string::String>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panic.rs:359:14
[INFO] [stdout]   31:     0x5c095b925935 - test[aada8e7e76ba119b]::run_test_in_process
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:724:27
[INFO] [stdout]   32:     0x5c095b925935 - test[aada8e7e76ba119b]::run_test::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:645:43
[INFO] [stdout]   33:     0x5c095b91f224 - test[aada8e7e76ba119b]::run_test::{closure#1}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/test/src/lib.rs:675:41
[INFO] [stdout]   34:     0x5c095b91f224 - std[617be2ca0a6fd877]::sys::backtrace::__rust_begin_short_backtrace::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/backtrace.rs:166:18
[INFO] [stdout]   35:     0x5c095b9289c2 - std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/thread/lifecycle.rs:70:13
[INFO] [stdout]   36:     0x5c095b9289c2 - <core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}> as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/panic/unwind_safe.rs:275:9
[INFO] [stdout]   37:     0x5c095b9289c2 - std[617be2ca0a6fd877]::panicking::catch_unwind::do_call::<core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:573:43
[INFO] [stdout]   38:     0x5c095b9289c2 - std[617be2ca0a6fd877]::panicking::catch_unwind::<(), core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panicking.rs:541:19
[INFO] [stdout]   39:     0x5c095b9289c2 - std[617be2ca0a6fd877]::panic::catch_unwind::<core[a373ad73a504971]::panic::unwind_safe::AssertUnwindSafe<std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}::{closure#0}>, ()>
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/panic.rs:359:14
[INFO] [stdout]   40:     0x5c095b9289c2 - std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked::<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/thread/lifecycle.rs:68:26
[INFO] [stdout]   41:     0x5c095b9289c2 - <std[617be2ca0a6fd877]::thread::lifecycle::spawn_unchecked<test[aada8e7e76ba119b]::run_test::{closure#1}, ()>::{closure#1} as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once::{shim:vtable#0}
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/core/src/ops/function.rs:250:5
[INFO] [stdout]   42:     0x5c095b99ca0f - <alloc[2e1b2a31b91974c5]::boxed::Box<dyn core[a373ad73a504971]::ops::function::FnOnce<(), Output = ()> + core[a373ad73a504971]::marker::Send> as core[a373ad73a504971]::ops::function::FnOnce<()>>::call_once
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/alloc/src/boxed.rs:2314:9
[INFO] [stdout]   43:     0x5c095b99ca0f - <std[617be2ca0a6fd877]::sys::thread::unix::Thread>::new::thread_start
[INFO] [stdout]                                at /rustc/e3feeb59cd1bdd011a2bfcc0747b55125d9b8527/library/std/src/sys/thread/unix.rs:127:17
[INFO] [stdout]   44:     0x73988e328dfa - <unknown>
[INFO] [stdout]   45:     0x73988e3bc3d4 - clone
[INFO] [stdout]   46:                0x0 - <unknown>
[INFO] [stdout] 
[INFO] [stdout] 
[INFO] [stdout] failures:
[INFO] [stdout]     stale_lock_from_dead_pid_is_stolen
[INFO] [stdout] 
[INFO] [stdout] test result: FAILED. 1 passed; 1 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.32s
[INFO] [stdout] 
[INFO] [stderr] error: test failed, to rerun pass `--test pidlock`
[INFO] running `Command { std: "docker" "inspect" "3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5", kill_on_drop: false }`
[INFO] [stdout] 3b5adca977d2369b266ab86b68726b90a8643bb63891c77c7eef261de5d311f5
