═══════════════════════════════════════════════════════════════════════════════════════════════════════════════════════ MAIN ═══════════════════════════════════════════════════════════════════════════════════════════════════════════════════════ ════════════════════════════════════════════════════ CAMPAIGN_13_1 ════════════════════════════════════════════════════ 2026-09-25 04:27:15.989 | INFO | CAMPAIGN_13_1 2026-09-25 04:27:15.992 | INFO | Count: 0 2026-09-25 04:27:16.012 | INFO | <<< UI ENSURE >>> 2026-09-25 04:27:16.015 | INFO | UI get current page 2026-09-25 04:27:16.690 | INFO | Unknown ui page 2026-09-25 04:27:17.173 | INFO | UI additional: IDLE -> REWARD_GOTO_MAIN 2026-09-25 04:27:17.176 | INFO | Click ( 858, 616) @ REWARD_GOTO_MAIN 2026-09-25 04:27:17.359 | INFO | Unknown ui page 2026-09-25 04:27:17.499 | INFO | [Package_name] com.bilibili.azurlane 2026-09-25 04:27:17.516 | INFO | [Device Orientation] 0 (Normal) 2026-09-25 04:27:17.662 | INFO | Unknown ui page 2026-09-25 04:27:17.958 | INFO | Unknown ui page 2026-09-25 04:27:18.172 | INFO | [UI] page_main 2026-09-25 04:27:18.176 | INFO | Goto page_campaign 2026-09-25 04:27:18.180 | INFO | <<< UI GOTO PAGE_CAMPAIGN >>> 2026-09-25 04:27:18.197 | INFO | Page switch: page_main_white -> page_campaign_menu 2026-09-25 04:27:18.201 | INFO | Click (1175, 526) @ MAIN_GOTO_CAMPAIGN_WHITE 2026-09-25 04:27:18.772 | INFO | Page switch: page_campaign_menu -> page_campaign 2026-09-25 04:27:18.775 | INFO | Click ( 427, 267) @ CAMPAIGN_MENU_GOTO_CAMPAIGN 2026-09-25 04:27:19.071 | INFO | Page arrive: page_campaign 2026-09-25 04:27:19.097 | INFO | Mode_switch_1 set to hard 2026-09-25 04:27:19.124 | INFO | [Mode_switch_1] hard 2026-09-25 04:27:19.127 | INFO | <<< UI ENSURE INDEX >>> 2026-09-25 04:27:19.197 | INFO | No stage found. 2026-09-25 04:27:19.433 | INFO | No stage found. 2026-09-25 04:27:19.738 | INFO | No stage found. 2026-09-25 04:27:20.062 | INFO | Loading OCR model: ./bin/cnocr_models/azur_lane 2026-09-25 04:27:20.188 | INFO | [campaign 0.142s] ['13--1', '13--3', '13--2', '13--4'] 2026-09-25 04:27:20.192 | INFO | [Chapter] 13 2026-09-25 04:27:20.194 | INFO | [Stage] 13-1, 13-3, 13-2, 13-4 2026-09-25 04:27:20.197 | INFO | [Index] 13 2026-09-25 04:27:20.267 | INFO | [OCR_OIL 0.042s] 2077 ──────────────────────────────────────────────────────── 13-1 ───────────────────────────────────────────────────────── 2026-09-25 04:27:20.273 | INFO | 13-1 2026-09-25 04:27:20.275 | INFO | Expect emotion reduce: (12, 2) 2026-09-25 04:27:20.286 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-09-25 04:27:20.289 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=119, Main.Emotion.Fleet1Record=datetime.datetime(2026, 9, 25, 4, 27, 20), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 9, 25, 4, 27, 20) 2026-09-25 04:27:20.305 | INFO | [Emotion fleet_1] 119 2026-09-25 04:27:20.308 | INFO | [Emotion fleet_2] 119 2026-09-25 04:27:20.310 | INFO | <<< ENTER MAP >>> 2026-09-25 04:27:20.384 | INFO | Click ( 185, 286) @ 13-1 2026-09-25 04:27:20.784 | INFO | [Map_clear_percentage] 5% 2026-09-25 04:27:21.094 | INFO | [Map_clear_percentage] 68% 2026-09-25 04:27:21.393 | INFO | [Map_clear_percentage] 99% 2026-09-25 04:27:21.422 | INFO | [MAP_CLEAR_ALL_THIS_TIME] False 2026-09-25 04:27:21.426 | INFO | [Map_info] 99%, star_1, star_2, star_3, 100_percent_clear, 3_stars, threat_safe, clear_mode 2026-09-25 04:27:21.430 | INFO | [StopCondition_MapAchievement] non_stop 2026-09-25 04:27:21.432 | INFO | Clear_Mode set to on 2026-09-25 04:27:21.437 | INFO | [Clear_Mode] on 2026-09-25 04:27:21.450 | INFO | Auto_Search set to on 2026-09-25 04:27:21.456 | INFO | [Auto_Search] on 2026-09-25 04:27:21.460 | INFO | Click (1035, 506) @ MAP_PREPARATION 2026-09-25 04:27:21.987 | INFO | Handling 2x book setting, mode=prep. 2026-09-25 04:27:22.008 | INFO | Using fleet: [4, 3, 1] 2026-09-25 04:27:22.079 | INFO | Hard satisfied: Fleet_1: None, Fleet_2: None, Submarine: None 2026-09-25 04:27:22.089 | INFO | [map_allow_submarine] True 2026-09-25 04:27:22.093 | INFO | Click (1138, 333) @ FLEET_2_CLEAR 2026-09-25 04:27:22.146 | INFO | Fleet SUBMARINE set to 1 2026-09-25 04:27:22.150 | INFO | Click (1039, 480) @ SUBMARINE_CHOOSE 2026-09-25 04:27:22.287 | INFO | FleetOption: [1] 2 2026-09-25 04:27:22.293 | INFO | Fleet option 1 is already selected 2026-09-25 04:27:22.295 | INFO | Click (1055, 474) @ SUBMARINE_CHOOSE 2026-09-25 04:27:22.585 | INFO | FleetOption: 2026-09-25 04:27:22.592 | INFO | Fleet FLEET_1 set to 4 2026-09-25 04:27:22.595 | INFO | Click (1054, 235) @ FLEET_1_CHOOSE 2026-09-25 04:27:22.886 | INFO | FleetOption: [1] 2 3 4 5 6 2026-09-25 04:27:22.890 | INFO | Click (1071, 411) @ FleetOption_4 2026-09-25 04:27:23.185 | INFO | FleetOption: 2026-09-25 04:27:23.188 | INFO | Fleet FLEET_2 set to 3 2026-09-25 04:27:23.191 | INFO | Click (1051, 327) @ FLEET_2_CHOOSE 2026-09-25 04:27:23.491 | INFO | FleetOption: 1 2 3 [4] 5 6 2026-09-25 04:27:23.494 | INFO | Click (1102, 481) @ FleetOption_3 2026-09-25 04:27:23.785 | INFO | FleetOption: 2026-09-25 04:27:23.790 | INFO | Auto search setting 2026-09-25 04:27:23.804 | INFO | [_fleet_sidebar_offset] 0 2026-09-25 04:27:23.810 | INFO | [_fleet_sidebar_offset] 0 2026-09-25 04:27:23.816 | INFO | [Fleet_sidebar] 1/3 2026-09-25 04:27:23.819 | INFO | Click (1217, 411) @ FLEET_SIDEBAR_0_2 2026-09-25 04:27:24.083 | INFO | [_fleet_sidebar_offset] 0 2026-09-25 04:27:24.088 | INFO | [Fleet_sidebar] 3/3 2026-09-25 04:27:24.092 | INFO | [Auto_Search_Setting] fleet1_all_fleet2_standby, sub_auto_call 2026-09-25 04:27:24.094 | INFO | Click ( 504, 219) @ AUTO_SEARCH_SET_MOB 2026-09-25 04:27:24.569 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_auto_call 2026-09-25 04:27:24.574 | INFO | Selected to the correct auto search setting 2026-09-25 04:27:24.577 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_auto_call 2026-09-25 04:27:24.579 | INFO | Click ( 903, 471) @ AUTO_SEARCH_SET_SUB_STANDBY 2026-09-25 04:27:25.064 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_standby 2026-09-25 04:27:25.068 | INFO | Selected to the correct auto search setting 2026-09-25 04:27:25.070 | INFO | Click (1078, 533) @ FLEET_PREPARATION 2026-09-25 04:27:30.179 | INFO | Handling 2x book setting, mode=prep. 2026-09-25 04:27:30.191 | INFO | Using fleet: [4, 3, 1] 2026-09-25 04:27:30.197 | INFO | Auto search setting 2026-09-25 04:27:30.203 | INFO | [_fleet_sidebar_offset] 0 2026-09-25 04:27:30.208 | INFO | [_fleet_sidebar_offset] 0 2026-09-25 04:27:30.214 | INFO | [Fleet_sidebar] 3/3 2026-09-25 04:27:30.218 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_standby 2026-09-25 04:27:30.220 | INFO | Selected to the correct auto search setting 2026-09-25 04:27:30.224 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_standby 2026-09-25 04:27:30.228 | INFO | Selected to the correct auto search setting 2026-09-25 04:27:30.230 | INFO | Click (1105, 581) @ FLEET_PREPARATION 2026-09-25 04:27:31.091 | INFO | is_auto_search_running appeared ────────────────────────────────────────────────────── BATTLE_0 ─────────────────────────────────────────────────────── 2026-09-25 04:27:31.098 | INFO | BATTLE_0 2026-09-25 04:27:31.101 | INFO | Auto search moving 2026-09-25 04:27:31.113 | INFO | Fleet: 1, fleet_current_index: 1 2026-09-25 04:27:31.152 | INFO | [OCR_OIL 0.036s] 2067 2026-09-25 04:27:31.203 | INFO | [OCR_COIN 0.048s] 15076 2026-09-25 04:27:36.332 | INFO | [Loading] 19% 2026-09-25 04:27:36.337 | INFO | Auto search combat loading 2026-09-25 04:27:36.341 | INFO | Screenshot interval set to 1.0s 2026-09-25 04:27:42.340 | INFO | [BattleUI] PAUSE 2026-09-25 04:27:42.344 | INFO | Auto Search combat execute 2026-09-25 04:27:42.347 | INFO | <<< EMOTION REDUCE >>> 2026-09-25 04:27:42.360 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-09-25 04:27:42.364 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=117, Main.Emotion.Fleet1Record=datetime.datetime(2026, 9, 25, 4, 27, 42), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 9, 25, 4, 27, 42) 2026-09-25 04:27:42.379 | INFO | [Emotion fleet_1] 117 2026-09-25 04:27:42.383 | INFO | [Emotion fleet_2] 119 2026-09-25 04:27:48.329 | INFO | Combat auto check timer reached 2026-09-25 04:28:07.365 | INFO | Screenshot interval set to 0.3s 2026-09-25 04:28:07.369 | INFO | Auto Search combat status 2026-09-25 04:28:08.256 | INFO | Click (1020, 665) @ GET_SHIP 2026-09-25 04:28:09.452 | INFO | Click (1018, 661) @ GET_SHIP 2026-09-25 04:28:13.952 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_1 ─────────────────────────────────────────────────────── 2026-09-25 04:28:13.959 | INFO | BATTLE_1 2026-09-25 04:28:13.962 | INFO | Auto search moving 2026-09-25 04:28:13.965 | INFO | Fleet: 1, fleet_current_index: 1 2026-09-25 04:28:14.095 | INFO | [OCR_OIL 0.126s] 2048 2026-09-25 04:28:14.167 | INFO | [OCR_COIN 0.067s] 15087 2026-09-25 04:28:18.468 | INFO | [Loading] 5% 2026-09-25 04:28:18.472 | INFO | Auto search combat loading 2026-09-25 04:28:18.476 | INFO | Screenshot interval set to 1.0s 2026-09-25 04:28:24.483 | INFO | [BattleUI] PAUSE 2026-09-25 04:28:24.489 | INFO | Auto Search combat execute 2026-09-25 04:28:24.493 | INFO | <<< EMOTION REDUCE >>> 2026-09-25 04:28:24.505 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-09-25 04:28:24.509 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=115, Main.Emotion.Fleet1Record=datetime.datetime(2026, 9, 25, 4, 28, 24), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 9, 25, 4, 28, 24) 2026-09-25 04:28:24.523 | INFO | [Emotion fleet_1] 115 2026-09-25 04:28:24.526 | INFO | [Emotion fleet_2] 119 2026-09-25 04:28:30.480 | INFO | Combat auto check timer reached 2026-09-25 04:29:06.521 | INFO | Screenshot interval set to 0.3s 2026-09-25 04:29:06.525 | INFO | Auto Search combat status 2026-09-25 04:29:11.312 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_2 ─────────────────────────────────────────────────────── 2026-09-25 04:29:11.317 | INFO | BATTLE_2 2026-09-25 04:29:11.320 | INFO | Auto search moving 2026-09-25 04:29:11.324 | INFO | Fleet: 1, fleet_current_index: 1 2026-09-25 04:29:11.418 | INFO | [OCR_OIL 0.087s] 2029 2026-09-25 04:29:11.530 | INFO | [OCR_COIN 0.109s] 15110 2026-09-25 04:29:15.830 | INFO | [Loading] 21% 2026-09-25 04:29:15.838 | INFO | Auto search combat loading 2026-09-25 04:29:15.843 | INFO | Screenshot interval set to 1.0s 2026-09-25 04:29:21.833 | INFO | [BattleUI] PAUSE 2026-09-25 04:29:21.843 | INFO | Auto Search combat execute 2026-09-25 04:29:21.847 | INFO | <<< EMOTION REDUCE >>> 2026-09-25 04:29:21.878 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-09-25 04:29:21.885 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=113, Main.Emotion.Fleet1Record=datetime.datetime(2026, 9, 25, 4, 29, 21), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 9, 25, 4, 29, 21) 2026-09-25 04:29:21.907 | INFO | [Emotion fleet_1] 113 2026-09-25 04:29:21.914 | INFO | [Emotion fleet_2] 119 2026-09-25 04:29:27.826 | INFO | Combat auto check timer reached 2026-09-25 04:29:47.854 | INFO | Click (1038, 651) @ GET_SHIP 2026-09-25 04:29:48.855 | INFO | Click (1029, 670) @ GET_SHIP 2026-09-25 04:29:51.859 | INFO | Screenshot interval set to 0.3s 2026-09-25 04:29:51.862 | INFO | Auto Search combat status 2026-09-25 04:29:53.037 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_3 ─────────────────────────────────────────────────────── 2026-09-25 04:29:53.042 | INFO | BATTLE_3 2026-09-25 04:29:53.044 | INFO | Auto search moving 2026-09-25 04:29:53.047 | INFO | Fleet: 1, fleet_current_index: 1 2026-09-25 04:29:53.108 | INFO | [OCR_OIL 0.058s] 2010 2026-09-25 04:29:53.156 | INFO | [OCR_COIN 0.046s] 15124 2026-09-25 04:29:57.252 | INFO | [Loading] 6% 2026-09-25 04:29:57.256 | INFO | Auto search combat loading 2026-09-25 04:29:57.259 | INFO | Screenshot interval set to 1.0s 2026-09-25 04:30:03.262 | INFO | [BattleUI] PAUSE 2026-09-25 04:30:03.268 | INFO | Auto Search combat execute 2026-09-25 04:30:03.273 | INFO | <<< EMOTION REDUCE >>> 2026-09-25 04:30:03.287 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-09-25 04:30:03.291 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=113, Main.Emotion.Fleet1Record=datetime.datetime(2026, 9, 25, 4, 30, 3), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 9, 25, 4, 30, 3) 2026-09-25 04:30:03.306 | INFO | [Emotion fleet_1] 113 2026-09-25 04:30:03.310 | INFO | [Emotion fleet_2] 119 2026-09-25 04:30:09.252 | INFO | Combat auto check timer reached 2026-09-25 04:31:05.319 | INFO | Click (1037, 677) @ GET_SHIP 2026-09-25 04:31:06.323 | INFO | Click (1039, 669) @ GET_SHIP 2026-09-25 04:31:09.329 | INFO | Screenshot interval set to 0.3s 2026-09-25 04:31:09.333 | INFO | Auto Search combat status 2026-09-25 04:31:10.805 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_4 ─────────────────────────────────────────────────────── 2026-09-25 04:31:10.810 | INFO | BATTLE_4 2026-09-25 04:31:10.812 | INFO | Auto search moving 2026-09-25 04:31:10.817 | INFO | Fleet: 1, fleet_current_index: 1 2026-09-25 04:31:10.873 | INFO | [OCR_OIL 0.052s] 1991 2026-09-25 04:31:10.876 | INFO | Reach oil limit 2026-09-25 04:31:10.968 | INFO | [OCR_COIN 0.090s] 15137 2026-09-25 04:31:15.320 | INFO | [Loading] 7% 2026-09-25 04:31:15.324 | INFO | Auto search combat loading 2026-09-25 04:31:15.327 | INFO | Screenshot interval set to 1.0s 2026-09-25 04:31:21.326 | INFO | [BattleUI] PAUSE 2026-09-25 04:31:21.330 | INFO | Auto Search combat execute 2026-09-25 04:31:21.333 | INFO | <<< EMOTION REDUCE >>> 2026-09-25 04:31:21.347 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-09-25 04:31:21.350 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=111, Main.Emotion.Fleet1Record=datetime.datetime(2026, 9, 25, 4, 31, 21), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 9, 25, 4, 31, 21) 2026-09-25 04:31:21.367 | INFO | [Emotion fleet_1] 111 2026-09-25 04:31:21.371 | INFO | [Emotion fleet_2] 119 2026-09-25 04:31:27.319 | INFO | Combat auto check timer reached 2026-09-25 04:32:04.367 | INFO | Screenshot interval set to 0.3s 2026-09-25 04:32:04.370 | INFO | Auto Search combat status 2026-09-25 04:32:05.262 | INFO | Click (1039, 667) @ GET_SHIP 2026-09-25 04:32:06.467 | INFO | Click (1030, 648) @ GET_SHIP 2026-09-25 04:32:10.960 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_5 ─────────────────────────────────────────────────────── 2026-09-25 04:32:10.967 | INFO | BATTLE_5 2026-09-25 04:32:10.970 | INFO | Auto search moving 2026-09-25 04:32:10.976 | INFO | Fleet: 1, fleet_current_index: 1 2026-09-25 04:32:11.077 | INFO | [OCR_OIL 0.096s] 1972 2026-09-25 04:32:11.081 | INFO | Reach oil limit 2026-09-25 04:32:11.154 | INFO | [OCR_COIN 0.069s] 15154 2026-09-25 04:32:13.376 | INFO | [Loading] 16% 2026-09-25 04:32:13.381 | INFO | Auto search combat loading 2026-09-25 04:32:13.385 | INFO | Screenshot interval set to 1.0s 2026-09-25 04:32:19.393 | INFO | [BattleUI] PAUSE 2026-09-25 04:32:19.396 | INFO | Auto Search combat execute 2026-09-25 04:32:19.400 | INFO | <<< EMOTION REDUCE >>> 2026-09-25 04:32:19.413 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-09-25 04:32:19.416 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=109, Main.Emotion.Fleet1Record=datetime.datetime(2026, 9, 25, 4, 32, 19), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 9, 25, 4, 32, 19) 2026-09-25 04:32:19.434 | INFO | [Emotion fleet_1] 109 2026-09-25 04:32:19.437 | INFO | [Emotion fleet_2] 119 2026-09-25 04:32:25.373 | INFO | Combat auto check timer reached 2026-09-25 04:35:19.542 | 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 L438 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-09-25 04:35:19.564 | WARNING | Wait too long 2026-09-25 04:35:19.569 | 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-09-25 04:35:19.623 | INFO | [Package_name] com.bilibili.azurlane 2026-09-25 04:35:19.626 | ERROR | GameStuckError: Wait too long 2026-09-25 04:35:19.629 | WARNING | Saving error: ./log/error/1790282119629