═══════════════════════════════════════════════════════════════════════════════════════════════════════════════════════ MAIN ═══════════════════════════════════════════════════════════════════════════════════════════════════════════════════════ ════════════════════════════════════════════════════ CAMPAIGN_13_1 ════════════════════════════════════════════════════ 2026-03-31 09:00:01.413 | INFO | CAMPAIGN_13_1 2026-03-31 09:00:01.417 | INFO | Count: 0 2026-03-31 09:00:01.439 | INFO | <<< UI ENSURE >>> 2026-03-31 09:00:01.443 | INFO | UI get current page 2026-03-31 09:00:01.967 | INFO | Unknown ui page 2026-03-31 09:00:02.423 | INFO | UI additional: IDLE -> REWARD_GOTO_MAIN 2026-03-31 09:00:02.428 | INFO | Click ( 833, 625) @ REWARD_GOTO_MAIN 2026-03-31 09:00:02.603 | INFO | Unknown ui page 2026-03-31 09:00:02.741 | INFO | [Package_name] com.bilibili.azurlane 2026-03-31 09:00:02.759 | INFO | [Device Orientation] 0 (Normal) 2026-03-31 09:00:02.909 | INFO | Unknown ui page 2026-03-31 09:00:03.204 | INFO | Unknown ui page 2026-03-31 09:00:03.429 | INFO | [UI] page_main 2026-03-31 09:00:03.431 | INFO | Goto page_campaign 2026-03-31 09:00:03.435 | INFO | <<< UI GOTO PAGE_CAMPAIGN >>> 2026-03-31 09:00:03.452 | INFO | Page switch: page_main_white -> page_campaign_menu 2026-03-31 09:00:03.458 | INFO | Click (1164, 482) @ MAIN_GOTO_CAMPAIGN_WHITE 2026-03-31 09:00:04.031 | INFO | Page switch: page_campaign_menu -> page_campaign 2026-03-31 09:00:04.035 | INFO | Click ( 392, 320) @ CAMPAIGN_MENU_GOTO_CAMPAIGN 2026-03-31 09:00:04.331 | INFO | Page arrive: page_campaign 2026-03-31 09:00:04.358 | INFO | Mode_switch_1 set to hard 2026-03-31 09:00:04.384 | INFO | [Mode_switch_1] hard 2026-03-31 09:00:04.387 | INFO | <<< UI ENSURE INDEX >>> 2026-03-31 09:00:04.462 | INFO | No stage found. 2026-03-31 09:00:04.694 | INFO | No stage found. 2026-03-31 09:00:05.052 | INFO | Loading OCR model: ./bin/cnocr_models/azur_lane 2026-03-31 09:00:05.169 | INFO | [campaign 0.137s] ['13--1', '13--3', '13--2', '13--4'] 2026-03-31 09:00:05.172 | INFO | [Chapter] 13 2026-03-31 09:00:05.174 | INFO | [Stage] 13-1, 13-3, 13-2, 13-4 2026-03-31 09:00:05.177 | INFO | [Index] 13 2026-03-31 09:00:05.251 | INFO | [OCR_OIL 0.045s] 23052 ──────────────────────────────────────────────────────── 13-1 ───────────────────────────────────────────────────────── 2026-03-31 09:00:05.256 | INFO | 13-1 2026-03-31 09:00:05.258 | INFO | Expect emotion reduce: (12, 2) 2026-03-31 09:00:05.270 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-31 09:00:05.273 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=53, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 31, 9, 0, 5), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 31, 9, 0, 5) 2026-03-31 09:00:05.287 | INFO | [Emotion fleet_1] 53 2026-03-31 09:00:05.291 | INFO | [Emotion fleet_2] 119 2026-03-31 09:00:05.294 | INFO | <<< ENTER MAP >>> 2026-03-31 09:00:05.371 | INFO | Click ( 174, 285) @ 13-1 2026-03-31 09:00:05.774 | INFO | [Map_clear_percentage] 11% 2026-03-31 09:00:06.077 | INFO | [Map_clear_percentage] 66% 2026-03-31 09:00:06.374 | INFO | [Map_clear_percentage] 99% 2026-03-31 09:00:06.398 | INFO | [MAP_CLEAR_ALL_THIS_TIME] False 2026-03-31 09:00:06.401 | INFO | [Map_info] 99%, star_1, star_2, star_3, 100_percent_clear, 3_stars, threat_safe, clear_mode 2026-03-31 09:00:06.407 | INFO | [StopCondition_MapAchievement] non_stop 2026-03-31 09:00:06.410 | INFO | Fast_Forward set to on 2026-03-31 09:00:06.413 | INFO | [Fast_Forward] on 2026-03-31 09:00:06.428 | INFO | Auto_Search set to on 2026-03-31 09:00:06.433 | INFO | [Auto_Search] on 2026-03-31 09:00:06.438 | INFO | Click ( 989, 513) @ MAP_PREPARATION 2026-03-31 09:00:06.678 | INFO | Handling 2x book setting, mode=prep. 2026-03-31 09:00:06.703 | INFO | Using fleet: [4, 3, 1] 2026-03-31 09:00:06.779 | INFO | Hard satisfied: Fleet_1: None, Fleet_2: None, Submarine: None 2026-03-31 09:00:06.788 | INFO | [map_allow_submarine] True 2026-03-31 09:00:06.794 | INFO | Click (1140, 325) @ FLEET_2_CLEAR 2026-03-31 09:00:06.849 | INFO | Click (1042, 469) @ SUBMARINE_CHOOSE 2026-03-31 09:00:07.271 | INFO | Current selected: [1] 2026-03-31 09:00:07.275 | INFO | Click (1048, 473) @ SUBMARINE_CHOOSE 2026-03-31 09:00:07.574 | INFO | Click (1071, 233) @ FLEET_1_CHOOSE 2026-03-31 09:00:07.873 | INFO | Current selected: [4] 2026-03-31 09:00:07.876 | INFO | Click (1052, 231) @ FLEET_1_CHOOSE 2026-03-31 09:00:08.170 | INFO | Click (1060, 335) @ FLEET_2_CHOOSE 2026-03-31 09:00:08.474 | INFO | Current selected: [4] 2026-03-31 09:00:08.477 | INFO | Click (1094, 493) @ FLEET_2_BAR_INDEX_3 2026-03-31 09:00:08.772 | INFO | Auto search setting 2026-03-31 09:00:08.788 | INFO | [_fleet_sidebar_offset] 0 2026-03-31 09:00:08.795 | INFO | [_fleet_sidebar_offset] 0 2026-03-31 09:00:08.800 | INFO | [Fleet_sidebar] 1/3 2026-03-31 09:00:08.804 | INFO | Click (1220, 408) @ FLEET_SIDEBAR_0_2 2026-03-31 09:00:09.075 | INFO | [_fleet_sidebar_offset] 0 2026-03-31 09:00:09.078 | INFO | [Fleet_sidebar] 3/3 2026-03-31 09:00:09.081 | INFO | [Auto_Search_Setting] fleet1_all_fleet2_standby, sub_standby 2026-03-31 09:00:09.084 | INFO | Click ( 506, 221) @ AUTO_SEARCH_SET_MOB 2026-03-31 09:00:09.602 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_standby 2026-03-31 09:00:09.607 | INFO | Selected to the correct auto search setting 2026-03-31 09:00:09.610 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_standby 2026-03-31 09:00:09.613 | INFO | Selected to the correct auto search setting 2026-03-31 09:00:09.615 | INFO | Click (1143, 594) @ FLEET_PREPARATION 2026-03-31 09:00:10.514 | INFO | is_auto_search_running appeared ────────────────────────────────────────────────────── BATTLE_0 ─────────────────────────────────────────────────────── 2026-03-31 09:00:10.518 | INFO | BATTLE_0 2026-03-31 09:00:10.520 | INFO | Auto search moving 2026-03-31 09:00:10.534 | INFO | Fleet: 1, fleet_current_index: 1 2026-03-31 09:00:10.594 | INFO | [OCR_OIL 0.053s] 23042 2026-03-31 09:00:10.663 | INFO | [OCR_COIN 0.066s] 243468 2026-03-31 09:00:14.547 | INFO | [Loading] 6% 2026-03-31 09:00:14.551 | INFO | Auto search combat loading 2026-03-31 09:00:14.553 | INFO | Screenshot interval set to 1.0s 2026-03-31 09:00:20.558 | INFO | [BattleUI] PAUSE 2026-03-31 09:00:20.562 | INFO | Auto Search combat execute 2026-03-31 09:00:20.566 | INFO | <<< EMOTION REDUCE >>> 2026-03-31 09:00:20.578 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-31 09:00:20.584 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=51, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 31, 9, 0, 20), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 31, 9, 0, 20) 2026-03-31 09:00:20.597 | INFO | [Emotion fleet_1] 51 2026-03-31 09:00:20.601 | INFO | [Emotion fleet_2] 119 2026-03-31 09:00:26.577 | INFO | Combat auto check timer reached 2026-03-31 09:01:04.597 | INFO | Screenshot interval set to 0.3s 2026-03-31 09:01:04.601 | INFO | Auto Search combat status 2026-03-31 09:01:05.193 | INFO | Click (1034, 654) @ GET_SHIP 2026-03-31 09:01:06.697 | INFO | Click (1021, 660) @ GET_SHIP 2026-03-31 09:01:07.902 | INFO | Click (1028, 660) @ GET_SHIP 2026-03-31 09:01:09.086 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_1 ─────────────────────────────────────────────────────── 2026-03-31 09:01:09.092 | INFO | BATTLE_1 2026-03-31 09:01:09.095 | INFO | Auto search moving 2026-03-31 09:01:09.100 | INFO | Fleet: 1, fleet_current_index: 1 2026-03-31 09:01:09.188 | INFO | [OCR_OIL 0.081s] 23023 2026-03-31 09:01:09.278 | INFO | [OCR_COIN 0.086s] 243486 2026-03-31 09:01:13.594 | INFO | [Loading] 11% 2026-03-31 09:01:13.597 | INFO | Auto search combat loading 2026-03-31 09:01:13.600 | INFO | Screenshot interval set to 1.0s 2026-03-31 09:01:19.612 | INFO | [BattleUI] PAUSE 2026-03-31 09:01:19.617 | INFO | Auto Search combat execute 2026-03-31 09:01:19.622 | INFO | <<< EMOTION REDUCE >>> 2026-03-31 09:01:19.637 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-31 09:01:19.651 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=49, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 31, 9, 1, 19), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 31, 9, 1, 19) 2026-03-31 09:01:19.667 | INFO | [Emotion fleet_1] 49 2026-03-31 09:01:19.671 | INFO | [Emotion fleet_2] 119 2026-03-31 09:01:25.610 | INFO | Combat auto check timer reached 2026-03-31 09:01:44.635 | INFO | Screenshot interval set to 0.3s 2026-03-31 09:01:44.639 | INFO | Auto Search combat status 2026-03-31 09:01:45.832 | INFO | Click (1020, 653) @ GET_SHIP 2026-03-31 09:01:47.040 | INFO | Click (1035, 651) @ GET_SHIP 2026-03-31 09:01:48.243 | INFO | Click (1018, 654) @ GET_SHIP 2026-03-31 09:01:49.121 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_2 ─────────────────────────────────────────────────────── 2026-03-31 09:01:49.127 | INFO | BATTLE_2 2026-03-31 09:01:49.130 | INFO | Auto search moving 2026-03-31 09:01:49.134 | INFO | Fleet: 1, fleet_current_index: 1 2026-03-31 09:01:49.212 | INFO | [OCR_OIL 0.072s] 23004 2026-03-31 09:01:49.278 | INFO | [OCR_COIN 0.060s] 243501 2026-03-31 09:01:53.933 | INFO | [Loading] 9% 2026-03-31 09:01:53.937 | INFO | Auto search combat loading 2026-03-31 09:01:53.941 | INFO | Screenshot interval set to 1.0s 2026-03-31 09:01:59.964 | INFO | [BattleUI] PAUSE 2026-03-31 09:01:59.967 | INFO | Auto Search combat execute 2026-03-31 09:01:59.969 | INFO | <<< EMOTION REDUCE >>> 2026-03-31 09:01:59.984 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-31 09:01:59.989 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=47, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 31, 9, 1, 59), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 31, 9, 1, 59) 2026-03-31 09:02:00.006 | INFO | [Emotion fleet_1] 47 2026-03-31 09:02:00.013 | INFO | [Emotion fleet_2] 119 2026-03-31 09:02:05.933 | INFO | Combat auto check timer reached 2026-03-31 09:02:24.973 | INFO | Screenshot interval set to 0.3s 2026-03-31 09:02:24.978 | INFO | Auto Search combat status 2026-03-31 09:02:25.861 | INFO | Click (1023, 659) @ GET_SHIP 2026-03-31 09:02:27.063 | INFO | Click (1039, 656) @ GET_SHIP 2026-03-31 09:02:28.262 | INFO | Click (1035, 658) @ GET_SHIP 2026-03-31 09:02:29.474 | INFO | Click (1030, 685) @ GET_SHIP 2026-03-31 09:02:31.256 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_3 ─────────────────────────────────────────────────────── 2026-03-31 09:02:31.263 | INFO | BATTLE_3 2026-03-31 09:02:31.265 | INFO | Auto search moving 2026-03-31 09:02:31.269 | INFO | Fleet: 1, fleet_current_index: 1 2026-03-31 09:02:31.348 | INFO | [OCR_OIL 0.075s] 22985 2026-03-31 09:02:31.439 | INFO | [OCR_COIN 0.087s] 243521 2026-03-31 09:02:35.770 | INFO | [Loading] 17% 2026-03-31 09:02:35.775 | INFO | Auto search combat loading 2026-03-31 09:02:35.778 | INFO | Screenshot interval set to 1.0s 2026-03-31 09:02:40.773 | INFO | [BattleUI] PAUSE 2026-03-31 09:02:40.776 | INFO | Auto Search combat execute 2026-03-31 09:02:40.778 | INFO | <<< EMOTION REDUCE >>> 2026-03-31 09:02:40.790 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-31 09:02:40.795 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=45, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 31, 9, 2, 40), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 31, 9, 2, 40) 2026-03-31 09:02:40.811 | INFO | [Emotion fleet_1] 45 2026-03-31 09:02:40.815 | INFO | [Emotion fleet_2] 119 2026-03-31 09:02:46.777 | INFO | Combat auto check timer reached 2026-03-31 09:03:23.814 | INFO | Screenshot interval set to 0.3s 2026-03-31 09:03:23.818 | INFO | Auto Search combat status 2026-03-31 09:03:25.011 | INFO | Click (1046, 658) @ GET_SHIP 2026-03-31 09:03:26.208 | INFO | Click (1002, 666) @ GET_SHIP 2026-03-31 09:03:27.423 | INFO | Click (1008, 664) @ GET_SHIP 2026-03-31 09:03:28.615 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_4 ─────────────────────────────────────────────────────── 2026-03-31 09:03:28.620 | INFO | BATTLE_4 2026-03-31 09:03:28.623 | INFO | Auto search moving 2026-03-31 09:03:28.627 | INFO | Fleet: 1, fleet_current_index: 1 2026-03-31 09:03:28.716 | INFO | [OCR_OIL 0.085s] 22966 2026-03-31 09:03:28.807 | INFO | [OCR_COIN 0.086s] 243536 2026-03-31 09:03:33.422 | INFO | [Loading] 11% 2026-03-31 09:03:33.428 | INFO | Auto search combat loading 2026-03-31 09:03:33.431 | INFO | Screenshot interval set to 1.0s 2026-03-31 09:03:39.424 | INFO | [BattleUI] PAUSE 2026-03-31 09:03:39.427 | INFO | Auto Search combat execute 2026-03-31 09:03:39.430 | INFO | <<< EMOTION REDUCE >>> 2026-03-31 09:03:39.441 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-31 09:03:39.445 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=43, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 31, 9, 3, 39), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 31, 9, 3, 39) 2026-03-31 09:03:39.464 | INFO | [Emotion fleet_1] 43 2026-03-31 09:03:39.467 | INFO | [Emotion fleet_2] 119 2026-03-31 09:03:44.432 | INFO | Combat auto check timer reached 2026-03-31 09:04:36.485 | INFO | Click (1047, 647) @ GET_SHIP 2026-03-31 09:04:37.491 | INFO | Click (1010, 649) @ GET_SHIP 2026-03-31 09:04:39.498 | INFO | Click (1036, 660) @ GET_SHIP 2026-03-31 09:04:40.491 | INFO | Screenshot interval set to 0.3s 2026-03-31 09:04:40.495 | INFO | Auto Search combat status 2026-03-31 09:04:40.508 | INFO | Click (1028, 666) @ GET_SHIP 2026-03-31 09:04:41.668 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_5 ─────────────────────────────────────────────────────── 2026-03-31 09:04:41.674 | INFO | BATTLE_5 2026-03-31 09:04:41.678 | INFO | Auto search moving 2026-03-31 09:04:41.682 | INFO | Fleet: 1, fleet_current_index: 1 2026-03-31 09:04:41.787 | INFO | [OCR_OIL 0.100s] 22947 2026-03-31 09:04:41.879 | INFO | [OCR_COIN 0.075s] 243549 2026-03-31 09:04:44.687 | INFO | [Loading] 12% 2026-03-31 09:04:44.691 | INFO | Auto search combat loading 2026-03-31 09:04:44.694 | INFO | Screenshot interval set to 1.0s 2026-03-31 09:04:50.696 | INFO | [BattleUI] PAUSE 2026-03-31 09:04:50.700 | INFO | Auto Search combat execute 2026-03-31 09:04:50.703 | INFO | <<< EMOTION REDUCE >>> 2026-03-31 09:04:50.723 | INFO | Bind task ['General', 'Alas', 'Main'] 2026-03-31 09:04:50.734 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=41, Main.Emotion.Fleet1Record=datetime.datetime(2026, 3, 31, 9, 4, 50), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2026, 3, 31, 9, 4, 50) 2026-03-31 09:04:50.749 | INFO | [Emotion fleet_1] 41 2026-03-31 09:04:50.757 | INFO | [Emotion fleet_2] 119 2026-03-31 09:04:56.688 | INFO | Combat auto check timer reached 2026-03-31 09:05:54.760 | INFO | Click (1017, 672) @ GET_SHIP 2026-03-31 09:08:54.891 | 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 L428 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-31 09:08:54.921 | WARNING | Wait too long 2026-03-31 09:08:54.926 | 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-31 09:08:54.998 | INFO | [Package_name] com.bilibili.azurlane 2026-03-31 09:08:55.003 | ERROR | GameStuckError: Wait too long 2026-03-31 09:08:55.006 | WARNING | Saving error: ./log/error/1774919335006