═══════════════════════════════════════════════════════════════════════════════════════════════════════════════════════ MAIN ═══════════════════════════════════════════════════════════════════════════════════════════════════════════════════════ ════════════════════════════════════════════════════ CAMPAIGN_13_1 ════════════════════════════════════════════════════ 2026-10-25 12:09:17.893 | INFO | CAMPAIGN_13_1 2026-10-25 12:09:17.897 | INFO | Campaign run: event="campaign_main", name=campaign_13_1 2026-10-25 12:09:17.899 | INFO | Count: 0 2026-10-25 12:09:17.916 | INFO | <<< UI ENSURE >>> 2026-10-25 12:09:17.919 | INFO | UI get current page 2026-10-25 12:09:17.972 | INFO | [UI] page_os 2026-10-25 12:09:17.980 | INFO | Goto page_campaign 2026-10-25 12:09:17.986 | INFO | <<< UI GOTO PAGE_CAMPAIGN >>> 2026-10-25 12:09:18.024 | INFO | Page switch: page_os -> page_main 2026-10-25 12:09:18.030 | INFO | Click (1242, 24) @ GOTO_MAIN 2026-10-25 12:09:18.781 | INFO | Page switch: page_main_white -> page_campaign_menu 2026-10-25 12:09:18.784 | INFO | Click (1173, 520) @ MAIN_GOTO_CAMPAIGN_WHITE 2026-10-25 12:09:19.373 | INFO | Page switch: page_campaign_menu -> page_campaign 2026-10-25 12:09:19.377 | INFO | Click ( 337, 286) @ CAMPAIGN_MENU_GOTO_CAMPAIGN 2026-10-25 12:09:19.667 | INFO | Page arrive: page_campaign 2026-10-25 12:09:19.691 | INFO | Mode_switch_1 set to hard 2026-10-25 12:09:19.716 | INFO | [Mode_switch_1] hard 2026-10-25 12:09:19.720 | INFO | <<< UI ENSURE INDEX >>> 2026-10-25 12:09:19.788 | INFO | No stage found. 2026-10-25 12:09:20.031 | INFO | No stage found. 2026-10-25 12:09:20.379 | INFO | [campaign 0.044s] ['3--1', '3--3', '3--2', '3--4'] 2026-10-25 12:09:20.382 | INFO | [Chapter] 3 2026-10-25 12:09:20.384 | INFO | [Stage] 3-1, 3-3, 3-2, 3-4 2026-10-25 12:09:20.387 | INFO | [Index] 3 2026-10-25 12:09:20.687 | INFO | [campaign 0.052s] ['13--1', '13--3', '13--2', '13--4'] 2026-10-25 12:09:20.692 | INFO | [Chapter] 13 2026-10-25 12:09:20.695 | INFO | [Stage] 13-1, 13-3, 13-2, 13-4 2026-10-25 12:09:20.699 | INFO | [Index] 13 2026-10-25 12:09:20.774 | INFO | [OCR_OIL 0.043s] 18668 ──────────────────────────────────────────────────────── 13-1 ───────────────────────────────────────────────────────── 2026-10-25 12:09:20.780 | INFO | 13-1 2026-10-25 12:09:20.783 | INFO | Expect emotion reduce: (12, 2) 2026-10-25 12:09:20.797 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-25 12:09:20.801 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=55, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 25, 12, 9, 20), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 25, 12, 9, 20) 2026-10-25 12:09:20.822 | INFO | [Emotion fleet_1] 55 2026-10-25 12:09:20.827 | INFO | [Emotion fleet_2] 119 2026-10-25 12:09:20.830 | INFO | <<< ENTER MAP >>> 2026-10-25 12:09:20.882 | INFO | Click ( 188, 288) @ 13-1 2026-10-25 12:09:21.582 | INFO | [Map_clear_percentage] 62% 2026-10-25 12:09:21.882 | INFO | [Map_clear_percentage] 99% 2026-10-25 12:09:21.908 | INFO | [MAP_CLEAR_ALL_THIS_TIME] False 2026-10-25 12:09:21.914 | INFO | [Map_info] 99%, star_1, star_2, star_3, 100_percent_clear, 3_stars, threat_safe, clear_mode 2026-10-25 12:09:21.917 | INFO | [StopCondition_MapAchievement] non_stop 2026-10-25 12:09:21.919 | INFO | Clear_Mode set to on 2026-10-25 12:09:21.923 | INFO | [Clear_Mode] on 2026-10-25 12:09:21.936 | INFO | Auto_Search set to on 2026-10-25 12:09:21.939 | INFO | [Auto_Search] on 2026-10-25 12:09:21.944 | INFO | Click (1041, 513) @ MAP_PREPARATION 2026-10-25 12:09:22.183 | INFO | Handling 2x book setting, mode=prep. 2026-10-25 12:09:22.486 | INFO | Using fleet: [4, 3, 1] 2026-10-25 12:09:22.564 | INFO | Hard satisfied: Fleet_1: None, Fleet_2: None, Submarine: None 2026-10-25 12:09:22.573 | INFO | [map_allow_submarine] True 2026-10-25 12:09:22.579 | INFO | Click (1130, 331) @ FLEET_2_CLEAR 2026-10-25 12:09:22.632 | INFO | Fleet SUBMARINE set to 1 2026-10-25 12:09:22.635 | INFO | Click (1054, 474) @ SUBMARINE_CHOOSE 2026-10-25 12:09:22.783 | INFO | FleetOption: [1] 2 2026-10-25 12:09:22.786 | INFO | Fleet option 1 is already selected 2026-10-25 12:09:22.789 | INFO | Click (1059, 465) @ SUBMARINE_CHOOSE 2026-10-25 12:09:23.078 | INFO | FleetOption: 2026-10-25 12:09:23.085 | INFO | Fleet FLEET_1 set to 4 2026-10-25 12:09:23.088 | INFO | Click (1051, 211) @ FLEET_1_CHOOSE 2026-10-25 12:09:23.382 | INFO | FleetOption: 1 2 3 [4] 5 6 2026-10-25 12:09:23.386 | INFO | Fleet option 4 is already selected 2026-10-25 12:09:23.389 | INFO | Click (1052, 216) @ FLEET_1_CHOOSE 2026-10-25 12:09:23.678 | INFO | FleetOption: 2026-10-25 12:09:23.682 | INFO | Fleet FLEET_2 set to 3 2026-10-25 12:09:23.685 | INFO | Click (1047, 340) @ FLEET_2_CHOOSE 2026-10-25 12:09:23.982 | INFO | FleetOption: 1 2 3 [4] 5 6 2026-10-25 12:09:23.986 | INFO | Click (1086, 484) @ FleetOption_3 2026-10-25 12:09:24.278 | INFO | FleetOption: 2026-10-25 12:09:24.283 | INFO | Auto search setting 2026-10-25 12:09:24.298 | INFO | [_fleet_sidebar_offset] 0 2026-10-25 12:09:24.305 | INFO | [_fleet_sidebar_offset] 0 2026-10-25 12:09:24.309 | INFO | [Fleet_sidebar] 1/3 2026-10-25 12:09:24.312 | INFO | Click (1218, 407) @ FLEET_SIDEBAR_0_2 2026-10-25 12:09:24.587 | INFO | [_fleet_sidebar_offset] 0 2026-10-25 12:09:24.592 | INFO | [Fleet_sidebar] 3/3 2026-10-25 12:09:24.595 | INFO | [Auto_Search_Setting] fleet1_all_fleet2_standby, sub_standby 2026-10-25 12:09:24.599 | INFO | Click ( 508, 211) @ AUTO_SEARCH_SET_MOB 2026-10-25 12:09:25.091 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_standby 2026-10-25 12:09:25.097 | INFO | Selected to the correct auto search setting 2026-10-25 12:09:25.101 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_standby 2026-10-25 12:09:25.105 | INFO | Selected to the correct auto search setting 2026-10-25 12:09:25.113 | INFO | Click (1064, 587) @ FLEET_PREPARATION 2026-10-25 12:09:26.609 | INFO | is_auto_search_running appeared ────────────────────────────────────────────────────── BATTLE_0 ─────────────────────────────────────────────────────── 2026-10-25 12:09:26.614 | INFO | BATTLE_0 2026-10-25 12:09:26.618 | INFO | Auto search moving 2026-10-25 12:09:26.635 | INFO | Fleet: 1, fleet_current_index: 1 2026-10-25 12:09:26.718 | INFO | [OCR_OIL 0.078s] 18658 2026-10-25 12:09:26.795 | INFO | [OCR_COIN 0.074s] 85856 2026-10-25 12:09:31.336 | INFO | [Loading] 7% 2026-10-25 12:09:31.339 | INFO | Auto search combat loading 2026-10-25 12:09:31.342 | INFO | Screenshot interval set to 1.0s 2026-10-25 12:09:37.371 | INFO | [BattleUI] PAUSE 2026-10-25 12:09:37.378 | INFO | Auto Search combat execute 2026-10-25 12:09:37.383 | INFO | <<< EMOTION REDUCE >>> 2026-10-25 12:09:37.403 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-25 12:09:37.413 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=53, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 25, 12, 9, 37), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 25, 12, 9, 37) 2026-10-25 12:09:37.431 | INFO | [Emotion fleet_1] 53 2026-10-25 12:09:37.434 | INFO | [Emotion fleet_2] 119 2026-10-25 12:09:43.354 | INFO | Combat auto check timer reached 2026-10-25 12:10:01.382 | INFO | Screenshot interval set to 0.3s 2026-10-25 12:10:01.388 | INFO | Auto Search combat status 2026-10-25 12:10:02.257 | INFO | Click (1024, 664) @ GET_SHIP 2026-10-25 12:10:03.459 | INFO | Click (1036, 657) @ GET_SHIP 2026-10-25 12:10:07.657 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_1 ─────────────────────────────────────────────────────── 2026-10-25 12:10:07.663 | INFO | BATTLE_1 2026-10-25 12:10:07.666 | INFO | Auto search moving 2026-10-25 12:10:07.669 | INFO | Fleet: 1, fleet_current_index: 1 2026-10-25 12:10:07.723 | INFO | [OCR_OIL 0.050s] 18639 2026-10-25 12:10:07.794 | INFO | [OCR_COIN 0.067s] 85867 2026-10-25 12:10:13.068 | INFO | [Loading] 7% 2026-10-25 12:10:13.072 | INFO | Auto search combat loading 2026-10-25 12:10:13.075 | INFO | Screenshot interval set to 1.0s 2026-10-25 12:10:19.102 | INFO | [BattleUI] PAUSE 2026-10-25 12:10:19.107 | INFO | Auto Search combat execute 2026-10-25 12:10:19.113 | INFO | <<< EMOTION REDUCE >>> 2026-10-25 12:10:19.130 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-25 12:10:19.138 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=51, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 25, 12, 10, 19), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 25, 12, 10, 19) 2026-10-25 12:10:19.155 | INFO | [Emotion fleet_1] 51 2026-10-25 12:10:19.159 | INFO | [Emotion fleet_2] 119 2026-10-25 12:10:25.068 | INFO | Combat auto check timer reached 2026-10-25 12:11:00.119 | INFO | Screenshot interval set to 0.3s 2026-10-25 12:11:00.123 | INFO | Auto Search combat status 2026-10-25 12:11:01.611 | INFO | Click (1041, 643) @ GET_SHIP 2026-10-25 12:11:02.808 | INFO | Click (1020, 654) @ GET_SHIP 2026-10-25 12:11:07.009 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_2 ─────────────────────────────────────────────────────── 2026-10-25 12:11:07.015 | INFO | BATTLE_2 2026-10-25 12:11:07.017 | INFO | Auto search moving 2026-10-25 12:11:07.020 | INFO | Fleet: 1, fleet_current_index: 1 2026-10-25 12:11:07.082 | INFO | [OCR_OIL 0.058s] 18620 2026-10-25 12:11:07.129 | INFO | [OCR_COIN 0.044s] 85887 2026-10-25 12:11:11.827 | INFO | [Loading] 4% 2026-10-25 12:11:11.830 | INFO | Auto search combat loading 2026-10-25 12:11:11.832 | INFO | Screenshot interval set to 1.0s 2026-10-25 12:11:17.866 | INFO | [BattleUI] PAUSE 2026-10-25 12:11:17.873 | INFO | Auto Search combat execute 2026-10-25 12:11:17.875 | INFO | <<< EMOTION REDUCE >>> 2026-10-25 12:11:17.889 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-25 12:11:17.894 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=49, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 25, 12, 11, 17), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 25, 12, 11, 17) 2026-10-25 12:11:17.910 | INFO | [Emotion fleet_1] 49 2026-10-25 12:11:17.913 | INFO | [Emotion fleet_2] 119 2026-10-25 12:11:23.823 | INFO | Combat auto check timer reached 2026-10-25 12:11:42.856 | INFO | Screenshot interval set to 0.3s 2026-10-25 12:11:42.859 | INFO | Auto Search combat status 2026-10-25 12:11:43.749 | INFO | Click (1022, 681) @ GET_SHIP 2026-10-25 12:11:44.959 | INFO | Click (1025, 646) @ GET_SHIP 2026-10-25 12:11:49.148 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_3 ─────────────────────────────────────────────────────── 2026-10-25 12:11:49.153 | INFO | BATTLE_3 2026-10-25 12:11:49.155 | INFO | Auto search moving 2026-10-25 12:11:49.162 | INFO | Fleet: 1, fleet_current_index: 1 2026-10-25 12:11:49.220 | INFO | [OCR_OIL 0.052s] 18601 2026-10-25 12:11:49.273 | INFO | [OCR_COIN 0.050s] 85902 2026-10-25 12:11:55.167 | INFO | [Loading] 7% 2026-10-25 12:11:55.171 | INFO | Auto search combat loading 2026-10-25 12:11:55.174 | INFO | Screenshot interval set to 1.0s 2026-10-25 12:12:01.170 | INFO | [BattleUI] PAUSE 2026-10-25 12:12:01.174 | INFO | Auto Search combat execute 2026-10-25 12:12:01.177 | INFO | <<< EMOTION REDUCE >>> 2026-10-25 12:12:01.190 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-25 12:12:01.193 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=49, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 25, 12, 12, 1), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 25, 12, 12, 1) 2026-10-25 12:12:01.208 | INFO | [Emotion fleet_1] 49 2026-10-25 12:12:01.212 | INFO | [Emotion fleet_2] 119 2026-10-25 12:12:07.162 | INFO | Combat auto check timer reached 2026-10-25 12:12:42.211 | INFO | Screenshot interval set to 0.3s 2026-10-25 12:12:42.216 | INFO | Auto Search combat status 2026-10-25 12:12:43.108 | INFO | Click (1026, 678) @ GET_SHIP 2026-10-25 12:12:44.304 | INFO | Click (1047, 666) @ GET_SHIP 2026-10-25 12:12:48.494 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_4 ─────────────────────────────────────────────────────── 2026-10-25 12:12:48.499 | INFO | BATTLE_4 2026-10-25 12:12:48.503 | INFO | Auto search moving 2026-10-25 12:12:48.509 | INFO | Fleet: 1, fleet_current_index: 1 2026-10-25 12:12:48.560 | INFO | [OCR_OIL 0.047s] 18582 2026-10-25 12:12:48.626 | INFO | [OCR_COIN 0.063s] 85914 2026-10-25 12:12:53.312 | INFO | [Loading] 7% 2026-10-25 12:12:53.316 | INFO | Auto search combat loading 2026-10-25 12:12:53.319 | INFO | Screenshot interval set to 1.0s 2026-10-25 12:12:59.337 | INFO | [BattleUI] PAUSE 2026-10-25 12:12:59.341 | INFO | Auto Search combat execute 2026-10-25 12:12:59.344 | INFO | <<< EMOTION REDUCE >>> 2026-10-25 12:12:59.360 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-25 12:12:59.365 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=47, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 25, 12, 12, 59), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 25, 12, 12, 59) 2026-10-25 12:12:59.379 | INFO | [Emotion fleet_1] 47 2026-10-25 12:12:59.384 | INFO | [Emotion fleet_2] 119 2026-10-25 12:13:05.325 | INFO | Combat auto check timer reached 2026-10-25 12:13:41.363 | INFO | Screenshot interval set to 0.3s 2026-10-25 12:13:41.368 | INFO | Auto Search combat status 2026-10-25 12:13:43.447 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_5 ─────────────────────────────────────────────────────── 2026-10-25 12:13:43.453 | INFO | BATTLE_5 2026-10-25 12:13:43.456 | INFO | Auto search moving 2026-10-25 12:13:43.460 | INFO | Fleet: 1, fleet_current_index: 1 2026-10-25 12:13:43.515 | INFO | [OCR_OIL 0.052s] 18563 2026-10-25 12:13:43.571 | INFO | [OCR_COIN 0.047s] 85938 2026-10-25 12:13:47.359 | INFO | [Loading] 16% 2026-10-25 12:13:47.364 | INFO | Auto search combat loading 2026-10-25 12:13:47.368 | INFO | Screenshot interval set to 1.0s 2026-10-25 12:13:53.380 | INFO | [BattleUI] PAUSE 2026-10-25 12:13:53.385 | INFO | Auto Search combat execute 2026-10-25 12:13:53.389 | INFO | <<< EMOTION REDUCE >>> 2026-10-25 12:13:53.403 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-25 12:13:53.408 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=45, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 25, 12, 13, 53), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 25, 12, 13, 53) 2026-10-25 12:13:53.423 | INFO | [Emotion fleet_1] 45 2026-10-25 12:13:53.428 | INFO | [Emotion fleet_2] 119 2026-10-25 12:13:59.363 | INFO | Combat auto check timer reached 2026-10-25 12:16:53.520 | INFO | Function calls: gui.py L94 process.py L112 start() context.py L223 _Popen() context.py L277 _Popen() popen_fork.py L20 __init__() popen_fork.py L74 _launch() process.py L297 _bootstrap() process.py L99 run() gui.py L85 func() main.py L463 run() server.py L60 run() runners.py L43 run() on.py L84 main() proxy_headers.py L75 __call__() applications.py L112 __call__() errors.py L146 __call__() base.py L21 __call__() exceptions.py L58 __call__() routing.py L569 __call__() routing.py L540 lifespan() routing.py L481 default_lifespan() routing.py L518 startup() app.py L1550 process_manager.py L227 restart_processes() process_manager.py L51 start() process.py L112 start() context.py L223 _Popen() context.py L277 _Popen() popen_fork.py L20 __init__() popen_fork.py L74 _launch() process.py L297 _bootstrap() process.py L99 run() process_manager.py L166 run_process() alas.py L587 loop() alas.py L69 run() alas.py L356 main() run.py L445 run() campaign_base.py L143 run() campaign_base.py L178 auto_search_execute_a_battle() auto_search_combat.py L357 auto_search_combat() auto_search_combat.py L252 auto_search_combat_execute() base.py L169 loop() device.py L194 screenshot() device.py L256 stuck_record_check() device.py L43 show_function_call() 2026-10-25 12:16:53.542 | WARNING | Wait too long 2026-10-25 12:16:53.546 | WARNING | Waiting for {'EXP_INFO_B', 'BATTLE_STATUS_B', 'EXP_INFO_A', 'EXP_INFO_S', 'GET_MISSION', 'GET_SHIP', 'COMBAT_AUTO', 'POPUP_CONFIRM_WHITE', 'COMBAT_AUTO_133', 'SP_CHECK', 'POPUP_CANCEL', 'AUTO_SEARCH_MAP_OPTION_ON', 'BATTLE_STATUS_A', 'MISSION_POPUP_GO', 'EVENT_CHECK', 'GUILD_POPUP_CONFIRM', 'BATTLE_STATUS_S', 'COMBAT_AUTO_150', 'CAMPAIGN_CHECK', 'PAUSE'} 2026-10-25 12:16:53.641 | INFO | [Package_name] com.bilibili.azurlane 2026-10-25 12:16:53.645 | ERROR | GameStuckError: Wait too long 2026-10-25 12:16:53.648 | WARNING | Saving error: ./log/error/1792901813648