═══════════════════════════════════════════════════════════════════════════════════════════════════════════════════════ MAIN ═══════════════════════════════════════════════════════════════════════════════════════════════════════════════════════ ════════════════════════════════════════════════════ CAMPAIGN_13_1 ════════════════════════════════════════════════════ 2026-03-25 20:54:04.244 | INFO | CAMPAIGN_13_1 2026-03-25 20:54:04.248 | INFO | Count: 0 2026-03-25 20:54:04.268 | INFO | <<< UI ENSURE >>> 2026-03-25 20:54:04.271 | INFO | UI get current page 2026-03-25 20:54:04.802 | INFO | Unknown ui page 2026-03-25 20:54:05.276 | INFO | UI additional: IDLE -> REWARD_GOTO_MAIN 2026-03-25 20:54:05.279 | INFO | Click ( 853, 617) @ REWARD_GOTO_MAIN 2026-03-25 20:54:05.451 | INFO | Unknown ui page 2026-03-25 20:54:05.594 | INFO | [Package_name] com.bilibili.azurlane 2026-03-25 20:54:05.613 | INFO | [Device Orientation] 0 (Normal) 2026-03-25 20:54:05.754 | INFO | Unknown ui page 2026-03-25 20:54:06.052 | INFO | Unknown ui page 2026-03-25 20:54:06.306 | INFO | [UI] page_main 2026-03-25 20:54:06.308 | INFO | Goto page_campaign 2026-03-25 20:54:06.311 | INFO | <<< UI GOTO PAGE_CAMPAIGN >>> 2026-03-25 20:54:06.328 | INFO | Page switch: page_main_white -> page_campaign_menu 2026-03-25 20:54:06.333 | INFO | Click (1223, 480) @ MAIN_GOTO_CAMPAIGN_WHITE 2026-03-25 20:54:06.881 | INFO | Page switch: page_campaign_menu -> page_campaign 2026-03-25 20:54:06.887 | INFO | Click ( 421, 371) @ CAMPAIGN_MENU_GOTO_CAMPAIGN 2026-03-25 20:54:07.180 | INFO | Page arrive: page_campaign 2026-03-25 20:54:07.207 | INFO | Mode_switch_1 set to hard 2026-03-25 20:54:07.231 | INFO | [Mode_switch_1] hard 2026-03-25 20:54:07.234 | INFO | <<< UI ENSURE INDEX >>> 2026-03-25 20:54:07.314 | INFO | No stage found. 2026-03-25 20:54:07.543 | INFO | No stage found. 2026-03-25 20:54:07.866 | INFO | Loading OCR model: ./bin/cnocr_models/azur_lane 2026-03-25 20:54:07.982 | INFO | [campaign 0.136s] ['13--1', '13--3', '13--2', '13--4'] 2026-03-25 20:54:07.988 | INFO | [Chapter] 13 2026-03-25 20:54:07.991 | INFO | [Stage] 13-1, 13-3, 13-2, 13-4 2026-03-25 20:54:07.993 | INFO | [Index] 13 2026-03-25 20:54:08.065 | INFO | [OCR_OIL 0.045s] 17897 ──────────────────────────────────────────────────────── 13-1 ───────────────────────────────────────────────────────── 2026-03-25 20:54:08.071 | INFO | 13-1 2026-03-25 20:54:08.075 | INFO | Expect emotion reduce: (12, 2) 2026-03-25 20:54:08.085 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-25 20:54:08.091 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=53, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 25, 20, 54, 8), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 25, 20, 54, 8) 2026-03-25 20:54:08.106 | INFO | [Emotion fleet_1] 53 2026-03-25 20:54:08.109 | INFO | [Emotion fleet_2] 119 2026-03-25 20:54:08.111 | INFO | <<< ENTER MAP >>> 2026-03-25 20:54:08.186 | INFO | Click ( 191, 280) @ 13-1 2026-03-25 20:54:08.599 | INFO | [Map_clear_percentage] 5% 2026-03-25 20:54:08.892 | INFO | [Map_clear_percentage] 66% 2026-03-25 20:54:09.191 | INFO | [Map_clear_percentage] 99% 2026-03-25 20:54:09.216 | INFO | [MAP_CLEAR_ALL_THIS_TIME] False 2026-03-25 20:54:09.222 | INFO | [Map_info] 99%, star_1, star_2, star_3, 100_percent_clear, 3_stars, threat_safe, clear_mode 2026-03-25 20:54:09.226 | INFO | [StopCondition_MapAchievement] non_stop 2026-03-25 20:54:09.228 | INFO | Fast_Forward set to on 2026-03-25 20:54:09.231 | INFO | [Fast_Forward] on 2026-03-25 20:54:09.244 | INFO | Auto_Search set to on 2026-03-25 20:54:09.248 | INFO | [Auto_Search] on 2026-03-25 20:54:09.252 | INFO | Click ( 941, 513) @ MAP_PREPARATION 2026-03-25 20:54:09.495 | INFO | Handling 2x book setting, mode=prep. 2026-03-25 20:54:09.795 | INFO | Using fleet: [4, 3, 1] 2026-03-25 20:54:09.874 | INFO | Hard satisfied: Fleet_1: None, Fleet_2: None, Submarine: None 2026-03-25 20:54:09.883 | INFO | [map_allow_submarine] True 2026-03-25 20:54:09.888 | INFO | Click (1130, 330) @ FLEET_2_CLEAR 2026-03-25 20:54:09.943 | INFO | Click (1040, 465) @ SUBMARINE_CHOOSE 2026-03-25 20:54:10.090 | INFO | Current selected: [1] 2026-03-25 20:54:10.094 | INFO | Click (1047, 463) @ SUBMARINE_CHOOSE 2026-03-25 20:54:10.391 | INFO | Click (1048, 214) @ FLEET_1_CHOOSE 2026-03-25 20:54:10.688 | INFO | Current selected: [4] 2026-03-25 20:54:10.692 | INFO | Click (1034, 226) @ FLEET_1_CHOOSE 2026-03-25 20:54:10.991 | INFO | Click (1050, 323) @ FLEET_2_CHOOSE 2026-03-25 20:54:11.296 | INFO | Current selected: [4] 2026-03-25 20:54:11.299 | INFO | Click (1090, 488) @ FLEET_2_BAR_INDEX_3 2026-03-25 20:54:11.592 | INFO | Auto search setting 2026-03-25 20:54:11.610 | INFO | [_fleet_sidebar_offset] 0 2026-03-25 20:54:11.616 | INFO | [_fleet_sidebar_offset] 0 2026-03-25 20:54:11.620 | INFO | [Fleet_sidebar] 1/3 2026-03-25 20:54:11.625 | INFO | Click (1205, 426) @ FLEET_SIDEBAR_0_2 2026-03-25 20:54:11.893 | INFO | [_fleet_sidebar_offset] 0 2026-03-25 20:54:11.897 | INFO | [Fleet_sidebar] 3/3 2026-03-25 20:54:11.900 | INFO | [Auto_Search_Setting] fleet1_all_fleet2_standby, sub_standby 2026-03-25 20:54:11.903 | INFO | Click ( 510, 220) @ AUTO_SEARCH_SET_MOB 2026-03-25 20:54:12.398 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_standby 2026-03-25 20:54:12.401 | INFO | Selected to the correct auto search setting 2026-03-25 20:54:12.406 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_standby 2026-03-25 20:54:12.412 | INFO | Selected to the correct auto search setting 2026-03-25 20:54:12.417 | INFO | Click (1046, 574) @ FLEET_PREPARATION 2026-03-25 20:54:13.310 | INFO | is_auto_search_running appeared ────────────────────────────────────────────────────── BATTLE_0 ─────────────────────────────────────────────────────── 2026-03-25 20:54:13.315 | INFO | BATTLE_0 2026-03-25 20:54:13.317 | INFO | Auto search moving 2026-03-25 20:54:13.332 | INFO | Fleet: 1, fleet_current_index: 1 2026-03-25 20:54:13.386 | INFO | [OCR_OIL 0.049s] 17887 2026-03-25 20:54:13.493 | INFO | [OCR_COIN 0.104s] 270680 2026-03-25 20:54:18.281 | INFO | [Loading] 8% 2026-03-25 20:54:18.286 | INFO | Auto search combat loading 2026-03-25 20:54:18.290 | INFO | Screenshot interval set to 1.0s 2026-03-25 20:54:24.290 | INFO | [BattleUI] PAUSE 2026-03-25 20:54:24.294 | INFO | Auto Search combat execute 2026-03-25 20:54:24.299 | INFO | <<< EMOTION REDUCE >>> 2026-03-25 20:54:24.314 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-25 20:54:24.320 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=51, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 25, 20, 54, 24), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 25, 20, 54, 24) 2026-03-25 20:54:24.332 | INFO | [Emotion fleet_1] 51 2026-03-25 20:54:24.336 | INFO | [Emotion fleet_2] 119 2026-03-25 20:54:30.283 | INFO | Combat auto check timer reached 2026-03-25 20:54:50.323 | INFO | Click (1026, 647) @ GET_SHIP 2026-03-25 20:54:52.320 | INFO | Click (1022, 686) @ GET_SHIP 2026-03-25 20:54:53.333 | INFO | Click (1011, 661) @ GET_SHIP 2026-03-25 20:54:55.340 | INFO | Click (1019, 651) @ GET_SHIP 2026-03-25 20:54:56.374 | INFO | Screenshot interval set to 0.3s 2026-03-25 20:54:56.378 | INFO | Auto Search combat status 2026-03-25 20:54:56.381 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_1 ─────────────────────────────────────────────────────── 2026-03-25 20:54:56.386 | INFO | BATTLE_1 2026-03-25 20:54:56.392 | INFO | Auto search moving 2026-03-25 20:54:56.397 | INFO | Fleet: 1, fleet_current_index: 1 2026-03-25 20:54:56.488 | INFO | [OCR_OIL 0.086s] 17868 2026-03-25 20:54:56.593 | INFO | [OCR_COIN 0.099s] 270695 2026-03-25 20:55:00.891 | INFO | [Loading] 13% 2026-03-25 20:55:00.896 | INFO | Auto search combat loading 2026-03-25 20:55:00.899 | INFO | Screenshot interval set to 1.0s 2026-03-25 20:55:05.897 | INFO | [BattleUI] PAUSE 2026-03-25 20:55:05.901 | INFO | Auto Search combat execute 2026-03-25 20:55:05.905 | INFO | <<< EMOTION REDUCE >>> 2026-03-25 20:55:05.920 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-25 20:55:05.926 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=49, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 25, 20, 55, 5), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 25, 20, 55, 5) 2026-03-25 20:55:05.946 | INFO | [Emotion fleet_1] 49 2026-03-25 20:55:05.950 | INFO | [Emotion fleet_2] 119 2026-03-25 20:55:11.895 | INFO | Combat auto check timer reached 2026-03-25 20:55:30.935 | INFO | Click (1031, 656) @ GET_SHIP 2026-03-25 20:55:32.932 | INFO | Click (1012, 648) @ GET_SHIP 2026-03-25 20:55:33.938 | INFO | Click (1039, 659) @ GET_SHIP 2026-03-25 20:55:35.940 | INFO | Click (1031, 659) @ GET_SHIP 2026-03-25 20:55:36.935 | INFO | Screenshot interval set to 0.3s 2026-03-25 20:55:36.938 | INFO | Auto Search combat status 2026-03-25 20:55:36.945 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_2 ─────────────────────────────────────────────────────── 2026-03-25 20:55:36.952 | INFO | BATTLE_2 2026-03-25 20:55:36.956 | INFO | Auto search moving 2026-03-25 20:55:36.961 | INFO | Fleet: 1, fleet_current_index: 1 2026-03-25 20:55:37.032 | INFO | [OCR_OIL 0.068s] 17849 2026-03-25 20:55:37.109 | INFO | [OCR_COIN 0.074s] 270717 2026-03-25 20:55:41.718 | INFO | [Loading] 7% 2026-03-25 20:55:41.721 | INFO | Auto search combat loading 2026-03-25 20:55:41.723 | INFO | Screenshot interval set to 1.0s 2026-03-25 20:55:47.730 | INFO | [BattleUI] PAUSE 2026-03-25 20:55:47.734 | INFO | Auto Search combat execute 2026-03-25 20:55:47.739 | INFO | <<< EMOTION REDUCE >>> 2026-03-25 20:55:47.750 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-25 20:55:47.755 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=47, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 25, 20, 55, 47), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 25, 20, 55, 47) 2026-03-25 20:55:47.770 | INFO | [Emotion fleet_1] 47 2026-03-25 20:55:47.776 | INFO | [Emotion fleet_2] 119 2026-03-25 20:55:52.742 | INFO | Combat auto check timer reached 2026-03-25 20:56:30.773 | INFO | Click (1021, 645) @ GET_SHIP 2026-03-25 20:56:31.787 | INFO | Click (1016, 650) @ GET_SHIP 2026-03-25 20:56:32.794 | INFO | Click (1033, 653) @ GET_SHIP 2026-03-25 20:56:33.780 | INFO | Screenshot interval set to 0.3s 2026-03-25 20:56:33.785 | INFO | Auto Search combat status 2026-03-25 20:56:33.789 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_3 ─────────────────────────────────────────────────────── 2026-03-25 20:56:33.801 | INFO | BATTLE_3 2026-03-25 20:56:33.804 | INFO | Auto search moving 2026-03-25 20:56:33.812 | INFO | Fleet: 1, fleet_current_index: 1 2026-03-25 20:56:33.909 | INFO | [OCR_OIL 0.091s] 17830 2026-03-25 20:56:33.991 | INFO | [OCR_COIN 0.076s] 270741 2026-03-25 20:56:38.585 | INFO | [Loading] 15% 2026-03-25 20:56:38.588 | INFO | Auto search combat loading 2026-03-25 20:56:38.593 | INFO | Screenshot interval set to 1.0s 2026-03-25 20:56:43.583 | INFO | [BattleUI] PAUSE 2026-03-25 20:56:43.586 | INFO | Auto Search combat execute 2026-03-25 20:56:43.590 | INFO | <<< EMOTION REDUCE >>> 2026-03-25 20:56:43.604 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-25 20:56:43.609 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=45, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 25, 20, 56, 43), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 25, 20, 56, 43) 2026-03-25 20:56:43.624 | INFO | [Emotion fleet_1] 45 2026-03-25 20:56:43.628 | INFO | [Emotion fleet_2] 119 2026-03-25 20:56:48.613 | INFO | Combat auto check timer reached 2026-03-25 20:57:08.609 | INFO | Click (1014, 655) @ GET_SHIP 2026-03-25 20:57:10.613 | INFO | Click (1036, 652) @ GET_SHIP 2026-03-25 20:57:11.622 | INFO | Click (1024, 678) @ GET_SHIP 2026-03-25 20:57:12.626 | INFO | Click (1034, 656) @ GET_SHIP 2026-03-25 20:57:13.631 | INFO | Click (1024, 655) @ GET_SHIP 2026-03-25 20:57:15.620 | INFO | Screenshot interval set to 0.3s 2026-03-25 20:57:15.624 | INFO | Auto Search combat status 2026-03-25 20:57:15.627 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_4 ─────────────────────────────────────────────────────── 2026-03-25 20:57:15.633 | INFO | BATTLE_4 2026-03-25 20:57:15.637 | INFO | Auto search moving 2026-03-25 20:57:15.641 | INFO | Fleet: 1, fleet_current_index: 1 2026-03-25 20:57:15.717 | INFO | [OCR_OIL 0.071s] 17811 2026-03-25 20:57:15.790 | INFO | [OCR_COIN 0.066s] 270762 2026-03-25 20:57:18.916 | INFO | [Loading] 14% 2026-03-25 20:57:18.921 | INFO | Auto search combat loading 2026-03-25 20:57:18.924 | INFO | Screenshot interval set to 1.0s 2026-03-25 20:57:24.931 | INFO | [BattleUI] PAUSE 2026-03-25 20:57:24.934 | INFO | Auto Search combat execute 2026-03-25 20:57:24.938 | INFO | <<< EMOTION REDUCE >>> 2026-03-25 20:57:24.949 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-25 20:57:24.954 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=43, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 25, 20, 57, 24), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 25, 20, 57, 24) 2026-03-25 20:57:24.972 | INFO | [Emotion fleet_1] 43 2026-03-25 20:57:24.975 | INFO | [Emotion fleet_2] 119 2026-03-25 20:57:30.922 | INFO | Combat auto check timer reached 2026-03-25 20:58:24.976 | INFO | Screenshot interval set to 0.3s 2026-03-25 20:58:24.981 | INFO | Auto Search combat status 2026-03-25 20:58:25.873 | INFO | Click (1021, 677) @ GET_SHIP 2026-03-25 20:58:27.067 | INFO | Click (1026, 665) @ GET_SHIP 2026-03-25 20:58:28.269 | INFO | Click (1035, 664) @ GET_SHIP 2026-03-25 20:58:29.466 | INFO | Click (1026, 652) @ GET_SHIP 2026-03-25 20:58:31.259 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_5 ─────────────────────────────────────────────────────── 2026-03-25 20:58:31.263 | INFO | BATTLE_5 2026-03-25 20:58:31.266 | INFO | Auto search moving 2026-03-25 20:58:31.272 | INFO | Fleet: 1, fleet_current_index: 1 2026-03-25 20:58:31.354 | INFO | [OCR_OIL 0.077s] 17792 2026-03-25 20:58:31.431 | INFO | [OCR_COIN 0.072s] 270777 2026-03-25 20:58:33.368 | INFO | [Loading] 13% 2026-03-25 20:58:33.372 | INFO | Auto search combat loading 2026-03-25 20:58:33.376 | INFO | Screenshot interval set to 1.0s 2026-03-25 20:58:39.381 | INFO | [BattleUI] PAUSE 2026-03-25 20:58:39.388 | INFO | Auto Search combat execute 2026-03-25 20:58:39.390 | INFO | <<< EMOTION REDUCE >>> 2026-03-25 20:58:39.409 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-25 20:58:39.415 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=41, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 25, 20, 58, 39), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 25, 20, 58, 39) 2026-03-25 20:58:39.434 | INFO | [Emotion fleet_1] 41 2026-03-25 20:58:39.438 | INFO | [Emotion fleet_2] 119 2026-03-25 20:58:45.381 | INFO | Combat auto check timer reached 2026-03-25 20:59:49.448 | INFO | Click (1035, 657) @ GET_SHIP 2026-03-25 21:02:49.597 | 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 L1523 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 L555 loop() alas.py L69 run() alas.py L352 main() run.py L426 run() campaign_base.py L143 run() campaign_base.py L178 auto_search_execute_a_battle() auto_search_combat.py L349 auto_search_combat() auto_search_combat.py L246 auto_search_combat_execute() base.py L169 loop() device.py L188 screenshot() device.py L250 stuck_record_check() device.py L43 show_function_call() 2026-03-25 21:02:49.620 | WARNING | Wait too long 2026-03-25 21:02:49.624 | WARNING | Waiting for {'SP_CHECK', 'EXP_INFO_B', 'EVENT_CHECK', 'POPUP_CONFIRM_WHITE', 'GUILD_POPUP_CONFIRM', 'GET_MISSION', 'GET_SHIP', 'PAUSE', 'EXP_INFO_S', 'AUTO_SEARCH_MAP_OPTION_ON', 'NEW_SHIP', 'BATTLE_STATUS_S', 'CAMPAIGN_CHECK', 'EXP_INFO_A', 'POPUP_CANCEL', 'BATTLE_STATUS_A', 'BATTLE_STATUS_B', 'MISSION_POPUP_GO'} 2026-03-25 21:02:49.684 | INFO | [Package_name] com.bilibili.azurlane 2026-03-25 21:02:49.688 | ERROR | GameStuckError: Wait too long 2026-03-25 21:02:49.691 | WARNING | Saving error: ./log/error/1774443769691