═══════════════════════════════════════════════════════════════════════════════════════════════════════════════════════ MAIN ═══════════════════════════════════════════════════════════════════════════════════════════════════════════════════════ ════════════════════════════════════════════════════ CAMPAIGN_13_1 ════════════════════════════════════════════════════ 2026-10-28 22:30:06.042 | INFO | CAMPAIGN_13_1 2026-10-28 22:30:06.045 | INFO | Campaign run: event="campaign_main", name=campaign_13_1 2026-10-28 22:30:06.048 | INFO | Count: 0 2026-10-28 22:30:06.065 | INFO | <<< UI ENSURE >>> 2026-10-28 22:30:06.068 | INFO | UI get current page 2026-10-28 22:30:06.724 | INFO | Unknown ui page 2026-10-28 22:30:07.215 | INFO | UI additional: IDLE -> REWARD_GOTO_MAIN 2026-10-28 22:30:07.219 | INFO | Click ( 838, 618) @ REWARD_GOTO_MAIN 2026-10-28 22:30:07.433 | INFO | Unknown ui page 2026-10-28 22:30:07.613 | INFO | [Package_name] com.bilibili.azurlane 2026-10-28 22:30:07.629 | INFO | [Device Orientation] 0 (Normal) 2026-10-28 22:30:07.764 | INFO | Unknown ui page 2026-10-28 22:30:08.059 | INFO | Unknown ui page 2026-10-28 22:30:08.273 | INFO | [UI] page_main 2026-10-28 22:30:08.277 | INFO | Goto page_campaign 2026-10-28 22:30:08.283 | INFO | <<< UI GOTO PAGE_CAMPAIGN >>> 2026-10-28 22:30:08.297 | INFO | Page switch: page_main_white -> page_campaign_menu 2026-10-28 22:30:08.300 | INFO | Click (1194, 525) @ MAIN_GOTO_CAMPAIGN_WHITE 2026-10-28 22:30:08.582 | INFO | Page switch: page_campaign_menu -> page_campaign 2026-10-28 22:30:08.586 | INFO | Click ( 334, 316) @ CAMPAIGN_MENU_GOTO_CAMPAIGN 2026-10-28 22:30:08.873 | INFO | Page arrive: page_campaign 2026-10-28 22:30:08.899 | INFO | Mode_switch_1 set to hard 2026-10-28 22:30:08.926 | INFO | [Mode_switch_1] hard 2026-10-28 22:30:08.931 | INFO | <<< UI ENSURE INDEX >>> 2026-10-28 22:30:09.007 | INFO | No stage found. 2026-10-28 22:30:09.238 | INFO | No stage found. 2026-10-28 22:30:09.542 | INFO | No stage found. 2026-10-28 22:30:09.860 | INFO | Loading OCR model: ./bin/cnocr_models/azur_lane 2026-10-28 22:30:09.970 | INFO | [campaign 0.132s] ['13--1', '13--3', '13--2', '13--4'] 2026-10-28 22:30:09.974 | INFO | [Chapter] 13 2026-10-28 22:30:09.976 | INFO | [Stage] 13-1, 13-3, 13-2, 13-4 2026-10-28 22:30:09.978 | INFO | [Index] 13 2026-10-28 22:30:10.041 | INFO | [OCR_OIL 0.035s] 18174 ──────────────────────────────────────────────────────── 13-1 ───────────────────────────────────────────────────────── 2026-10-28 22:30:10.046 | INFO | 13-1 2026-10-28 22:30:10.050 | INFO | Expect emotion reduce: (12, 2) 2026-10-28 22:30:10.061 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-28 22:30:10.067 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=53, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 28, 22, 30, 10), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 28, 22, 30, 10) 2026-10-28 22:30:10.082 | INFO | [Emotion fleet_1] 53 2026-10-28 22:30:10.084 | INFO | [Emotion fleet_2] 119 2026-10-28 22:30:10.087 | INFO | <<< ENTER MAP >>> 2026-10-28 22:30:10.159 | INFO | Click ( 196, 289) @ 13-1 2026-10-28 22:30:10.558 | INFO | [Map_clear_percentage] 5% 2026-10-28 22:30:10.858 | INFO | [Map_clear_percentage] 66% 2026-10-28 22:30:11.158 | INFO | [Map_clear_percentage] 99% 2026-10-28 22:30:11.187 | INFO | [MAP_CLEAR_ALL_THIS_TIME] False 2026-10-28 22:30:11.190 | INFO | [Map_info] 99%, star_1, star_2, star_3, 100_percent_clear, 3_stars, threat_safe, clear_mode 2026-10-28 22:30:11.193 | INFO | [StopCondition_MapAchievement] non_stop 2026-10-28 22:30:11.196 | INFO | Clear_Mode set to on 2026-10-28 22:30:11.199 | INFO | [Clear_Mode] on 2026-10-28 22:30:11.214 | INFO | Auto_Search set to on 2026-10-28 22:30:11.219 | INFO | [Auto_Search] on 2026-10-28 22:30:11.222 | INFO | Click (1019, 513) @ MAP_PREPARATION 2026-10-28 22:30:11.760 | INFO | Handling 2x book setting, mode=prep. 2026-10-28 22:30:11.782 | INFO | Using fleet: [4, 3, 1] 2026-10-28 22:30:11.853 | INFO | Hard satisfied: Fleet_1: None, Fleet_2: None, Submarine: None 2026-10-28 22:30:11.862 | INFO | [map_allow_submarine] True 2026-10-28 22:30:11.867 | INFO | Click (1146, 333) @ FLEET_2_CLEAR 2026-10-28 22:30:11.921 | INFO | Fleet SUBMARINE set to 1 2026-10-28 22:30:11.924 | INFO | Click (1063, 487) @ SUBMARINE_CHOOSE 2026-10-28 22:30:12.059 | INFO | FleetOption: [1] 2 2026-10-28 22:30:12.064 | INFO | Fleet option 1 is already selected 2026-10-28 22:30:12.068 | INFO | Click (1048, 478) @ SUBMARINE_CHOOSE 2026-10-28 22:30:12.360 | INFO | FleetOption: 2026-10-28 22:30:12.368 | INFO | Fleet FLEET_1 set to 4 2026-10-28 22:30:12.371 | INFO | Click (1046, 232) @ FLEET_1_CHOOSE 2026-10-28 22:30:12.673 | INFO | FleetOption: 1 2 3 [4] 5 6 2026-10-28 22:30:12.678 | INFO | Fleet option 4 is already selected 2026-10-28 22:30:12.682 | INFO | Click (1038, 224) @ FLEET_1_CHOOSE 2026-10-28 22:30:12.963 | INFO | FleetOption: 2026-10-28 22:30:12.967 | INFO | Fleet FLEET_2 set to 3 2026-10-28 22:30:12.970 | INFO | Click (1045, 337) @ FLEET_2_CHOOSE 2026-10-28 22:30:13.276 | INFO | FleetOption: 1 2 3 [4] 5 6 2026-10-28 22:30:13.281 | INFO | Click (1079, 478) @ FleetOption_3 2026-10-28 22:30:13.559 | INFO | FleetOption: 2026-10-28 22:30:13.563 | INFO | Auto search setting 2026-10-28 22:30:13.583 | INFO | [_fleet_sidebar_offset] 0 2026-10-28 22:30:13.590 | INFO | [_fleet_sidebar_offset] 0 2026-10-28 22:30:13.594 | INFO | [Fleet_sidebar] 1/3 2026-10-28 22:30:13.601 | INFO | Click (1220, 446) @ FLEET_SIDEBAR_0_2 2026-10-28 22:30:13.858 | INFO | [_fleet_sidebar_offset] 0 2026-10-28 22:30:13.862 | INFO | [Fleet_sidebar] 3/3 2026-10-28 22:30:13.868 | INFO | [Auto_Search_Setting] fleet1_all_fleet2_standby, sub_standby 2026-10-28 22:30:13.871 | INFO | Click ( 501, 218) @ AUTO_SEARCH_SET_MOB 2026-10-28 22:30:14.394 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_standby 2026-10-28 22:30:14.398 | INFO | Selected to the correct auto search setting 2026-10-28 22:30:14.404 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_standby 2026-10-28 22:30:14.406 | INFO | Selected to the correct auto search setting 2026-10-28 22:30:14.413 | INFO | Click (1079, 579) @ FLEET_PREPARATION 2026-10-28 22:30:15.620 | INFO | is_auto_search_running appeared ────────────────────────────────────────────────────── BATTLE_0 ─────────────────────────────────────────────────────── 2026-10-28 22:30:15.628 | INFO | BATTLE_0 2026-10-28 22:30:15.631 | INFO | Auto search moving 2026-10-28 22:30:15.648 | INFO | Fleet: 1, fleet_current_index: 1 2026-10-28 22:30:15.729 | INFO | [OCR_OIL 0.073s] 18164 2026-10-28 22:30:15.790 | INFO | [OCR_COIN 0.058s] 55533 2026-10-28 22:30:21.826 | INFO | [Loading] 4% 2026-10-28 22:30:21.829 | INFO | Auto search combat loading 2026-10-28 22:30:21.831 | INFO | Screenshot interval set to 1.0s 2026-10-28 22:30:27.840 | INFO | [BattleUI] PAUSE 2026-10-28 22:30:27.845 | INFO | Auto Search combat execute 2026-10-28 22:30:27.851 | INFO | <<< EMOTION REDUCE >>> 2026-10-28 22:30:27.868 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-28 22:30:27.873 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=51, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 28, 22, 30, 27), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 28, 22, 30, 27) 2026-10-28 22:30:27.890 | INFO | [Emotion fleet_1] 51 2026-10-28 22:30:27.893 | INFO | [Emotion fleet_2] 119 2026-10-28 22:30:33.830 | INFO | Combat auto check timer reached 2026-10-28 22:31:11.880 | INFO | Click (1042, 656) @ GET_SHIP 2026-10-28 22:31:12.881 | INFO | Click (1040, 652) @ GET_SHIP 2026-10-28 22:31:15.901 | INFO | Screenshot interval set to 0.3s 2026-10-28 22:31:15.907 | INFO | Auto Search combat status 2026-10-28 22:31:17.062 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_1 ─────────────────────────────────────────────────────── 2026-10-28 22:31:17.068 | INFO | BATTLE_1 2026-10-28 22:31:17.070 | INFO | Auto search moving 2026-10-28 22:31:17.073 | INFO | Fleet: 1, fleet_current_index: 1 2026-10-28 22:31:17.130 | INFO | [OCR_OIL 0.053s] 18145 2026-10-28 22:31:17.191 | INFO | [OCR_COIN 0.058s] 55549 2026-10-28 22:31:23.980 | INFO | [Loading] 12% 2026-10-28 22:31:23.984 | INFO | Auto search combat loading 2026-10-28 22:31:23.988 | INFO | Screenshot interval set to 1.0s 2026-10-28 22:31:29.988 | INFO | [BattleUI] PAUSE 2026-10-28 22:31:29.992 | INFO | Auto Search combat execute 2026-10-28 22:31:29.995 | INFO | <<< EMOTION REDUCE >>> 2026-10-28 22:31:30.008 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-28 22:31:30.013 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=49, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 28, 22, 31, 29), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 28, 22, 31, 29) 2026-10-28 22:31:30.031 | INFO | [Emotion fleet_1] 49 2026-10-28 22:31:30.034 | INFO | [Emotion fleet_2] 119 2026-10-28 22:31:35.976 | INFO | Combat auto check timer reached 2026-10-28 22:31:58.031 | INFO | Click (1021, 658) @ GET_SHIP 2026-10-28 22:32:01.029 | INFO | Screenshot interval set to 0.3s 2026-10-28 22:32:01.033 | INFO | Auto Search combat status 2026-10-28 22:32:02.199 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_2 ─────────────────────────────────────────────────────── 2026-10-28 22:32:02.205 | INFO | BATTLE_2 2026-10-28 22:32:02.210 | INFO | Auto search moving 2026-10-28 22:32:02.215 | INFO | Fleet: 1, fleet_current_index: 1 2026-10-28 22:32:02.343 | INFO | [OCR_OIL 0.124s] 18126 2026-10-28 22:32:02.464 | INFO | [OCR_COIN 0.114s] 55572 2026-10-28 22:32:10.058 | INFO | [Loading] 12% 2026-10-28 22:32:10.062 | INFO | Auto search combat loading 2026-10-28 22:32:10.066 | INFO | Screenshot interval set to 1.0s 2026-10-28 22:32:16.059 | INFO | [BattleUI] PAUSE 2026-10-28 22:32:16.067 | INFO | Auto Search combat execute 2026-10-28 22:32:16.070 | INFO | <<< EMOTION REDUCE >>> 2026-10-28 22:32:16.082 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-28 22:32:16.086 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=47, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 28, 22, 32, 16), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 28, 22, 32, 16) 2026-10-28 22:32:16.101 | INFO | [Emotion fleet_1] 47 2026-10-28 22:32:16.104 | INFO | [Emotion fleet_2] 119 2026-10-28 22:32:22.053 | INFO | Combat auto check timer reached 2026-10-28 22:33:20.131 | INFO | Screenshot interval set to 0.3s 2026-10-28 22:33:20.134 | INFO | Auto Search combat status 2026-10-28 22:33:21.616 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_3 ─────────────────────────────────────────────────────── 2026-10-28 22:33:21.621 | INFO | BATTLE_3 2026-10-28 22:33:21.623 | INFO | Auto search moving 2026-10-28 22:33:21.627 | INFO | Fleet: 1, fleet_current_index: 1 2026-10-28 22:33:21.688 | INFO | [OCR_OIL 0.057s] 18107 2026-10-28 22:33:21.739 | INFO | [OCR_COIN 0.047s] 55593 2026-10-28 22:33:32.451 | INFO | [Loading] 13% 2026-10-28 22:33:32.454 | INFO | Auto search combat loading 2026-10-28 22:33:32.458 | INFO | Screenshot interval set to 1.0s 2026-10-28 22:33:38.447 | INFO | [BattleUI] PAUSE 2026-10-28 22:33:38.451 | INFO | Auto Search combat execute 2026-10-28 22:33:38.454 | INFO | <<< EMOTION REDUCE >>> 2026-10-28 22:33:38.468 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-28 22:33:38.472 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=45, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 28, 22, 33, 38), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 28, 22, 33, 38) 2026-10-28 22:33:38.484 | INFO | [Emotion fleet_1] 45 2026-10-28 22:33:38.488 | INFO | [Emotion fleet_2] 119 2026-10-28 22:33:44.439 | INFO | Combat auto check timer reached 2026-10-28 22:34:23.484 | INFO | Click (1029, 665) @ GET_SHIP 2026-10-28 22:34:25.500 | INFO | Click (1009, 643) @ GET_SHIP 2026-10-28 22:34:28.497 | INFO | Screenshot interval set to 0.3s 2026-10-28 22:34:28.501 | INFO | Auto Search combat status 2026-10-28 22:34:29.671 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_4 ─────────────────────────────────────────────────────── 2026-10-28 22:34:29.675 | INFO | BATTLE_4 2026-10-28 22:34:29.678 | INFO | Auto search moving 2026-10-28 22:34:29.680 | INFO | Fleet: 1, fleet_current_index: 1 2026-10-28 22:34:29.740 | INFO | [OCR_OIL 0.057s] 18088 2026-10-28 22:34:29.810 | INFO | [OCR_COIN 0.066s] 55607 2026-10-28 22:34:37.793 | INFO | [Loading] 11% 2026-10-28 22:34:37.798 | INFO | Auto search combat loading 2026-10-28 22:34:37.801 | INFO | Screenshot interval set to 1.0s 2026-10-28 22:34:43.809 | INFO | [BattleUI] PAUSE 2026-10-28 22:34:43.815 | INFO | Auto Search combat execute 2026-10-28 22:34:43.819 | INFO | <<< EMOTION REDUCE >>> 2026-10-28 22:34:43.834 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-28 22:34:43.840 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=43, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 28, 22, 34, 43), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 28, 22, 34, 43) 2026-10-28 22:34:43.860 | INFO | [Emotion fleet_1] 43 2026-10-28 22:34:43.864 | INFO | [Emotion fleet_2] 119 2026-10-28 22:34:49.806 | INFO | Combat auto check timer reached 2026-10-28 22:35:28.838 | INFO | Screenshot interval set to 0.3s 2026-10-28 22:35:28.842 | INFO | Auto Search combat status 2026-10-28 22:35:30.332 | INFO | Click (1018, 661) @ GET_SHIP 2026-10-28 22:35:31.537 | INFO | Click (1019, 668) @ GET_SHIP 2026-10-28 22:35:39.327 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_5 ─────────────────────────────────────────────────────── 2026-10-28 22:35:39.333 | INFO | BATTLE_5 2026-10-28 22:35:39.338 | INFO | Auto search moving 2026-10-28 22:35:39.342 | INFO | Fleet: 1, fleet_current_index: 1 2026-10-28 22:35:39.407 | INFO | [OCR_OIL 0.061s] 18069 2026-10-28 22:35:39.459 | INFO | [OCR_COIN 0.049s] 55635 2026-10-28 22:35:45.642 | INFO | [Loading] 15% 2026-10-28 22:35:45.646 | INFO | Auto search combat loading 2026-10-28 22:35:45.648 | INFO | Screenshot interval set to 1.0s 2026-10-28 22:35:51.654 | INFO | [BattleUI] PAUSE 2026-10-28 22:35:51.657 | INFO | Auto Search combat execute 2026-10-28 22:35:51.660 | INFO | <<< EMOTION REDUCE >>> 2026-10-28 22:35:51.674 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-10-28 22:35:51.681 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=41, Main.Emotion.Fleet1Record=datetime.datetime(2026, 10, 28, 22, 35, 51), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 10, 28, 22, 35, 51) 2026-10-28 22:35:51.696 | INFO | [Emotion fleet_1] 41 2026-10-28 22:35:51.701 | INFO | [Emotion fleet_2] 119 2026-10-28 22:35:57.641 | INFO | Combat auto check timer reached 2026-10-28 22:38:51.812 | 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 L591 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-28 22:38:51.838 | WARNING | Wait too long 2026-10-28 22:38:51.842 | 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-28 22:38:51.891 | INFO | [Package_name] com.bilibili.azurlane 2026-10-28 22:38:51.897 | ERROR | GameStuckError: Wait too long 2026-10-28 22:38:51.901 | WARNING | Saving error: ./log/error/1793198331901