═══════════════════════════════════════════════════════════════════════════════════════════════════════════════════════ MAIN ═══════════════════════════════════════════════════════════════════════════════════════════════════════════════════════ ════════════════════════════════════════════════════ CAMPAIGN_13_1 ════════════════════════════════════════════════════ 2025-10-02 02:48:06.068 | INFO | CAMPAIGN_13_1 2025-10-02 02:48:06.072 | INFO | Count: 0 2025-10-02 02:48:06.096 | INFO | <<< UI ENSURE >>> 2025-10-02 02:48:06.102 | INFO | UI get current page 2025-10-02 02:48:06.631 | INFO | Unknown ui page 2025-10-02 02:48:07.107 | INFO | UI additional: IDLE -> REWARD_GOTO_MAIN 2025-10-02 02:48:07.111 | INFO | Click ( 815, 623) @ REWARD_GOTO_MAIN 2025-10-02 02:48:07.287 | INFO | Unknown ui page 2025-10-02 02:48:07.437 | INFO | [Package_name] com.bilibili.azurlane 2025-10-02 02:48:07.455 | INFO | [Device Orientation] 0 (Normal) 2025-10-02 02:48:07.601 | INFO | Unknown ui page 2025-10-02 02:48:07.813 | INFO | [UI] page_main 2025-10-02 02:48:07.817 | INFO | Goto page_campaign 2025-10-02 02:48:07.820 | INFO | <<< UI GOTO PAGE_CAMPAIGN >>> 2025-10-02 02:48:07.838 | INFO | Page switch: page_main_white -> page_campaign_menu 2025-10-02 02:48:07.844 | INFO | Click (1200, 495) @ MAIN_GOTO_CAMPAIGN_WHITE 2025-10-02 02:48:08.415 | INFO | Page switch: page_campaign_menu -> page_campaign 2025-10-02 02:48:08.418 | INFO | Click ( 420, 386) @ CAMPAIGN_MENU_GOTO_CAMPAIGN 2025-10-02 02:48:08.709 | INFO | Page arrive: page_campaign 2025-10-02 02:48:08.733 | INFO | Mode_switch_1 set to hard 2025-10-02 02:48:08.760 | INFO | [Mode_switch_1] hard 2025-10-02 02:48:08.763 | INFO | <<< UI ENSURE INDEX >>> 2025-10-02 02:48:08.837 | INFO | No stage found. 2025-10-02 02:48:09.075 | INFO | No stage found. 2025-10-02 02:48:09.377 | INFO | No stage found. 2025-10-02 02:48:09.695 | INFO | Loading OCR model: ./bin/cnocr_models/azur_lane 2025-10-02 02:48:09.817 | INFO | [campaign 0.140s] ['13--1', '13--3', '13--2', '13--4'] 2025-10-02 02:48:09.820 | INFO | [Chapter] 13 2025-10-02 02:48:09.826 | INFO | [Stage] 13-1, 13-3, 13-2, 13-4 2025-10-02 02:48:09.829 | INFO | [Index] 13 2025-10-02 02:48:09.903 | INFO | [OCR_OIL 0.047s] 5494 ──────────────────────────────────────────────────────── 13-1 ───────────────────────────────────────────────────────── 2025-10-02 02:48:09.908 | INFO | 13-1 2025-10-02 02:48:09.912 | INFO | Expect emotion reduce: (12, 2) 2025-10-02 02:48:09.921 | INFO | Bind task ['General', 'Alas', 'Main'] 2025-10-02 02:48:09.928 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=53, Main.Emotion.Fleet1Record=datetime.datetime(2025, 10, 2, 2, 48, 9), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2025, 10, 2, 2, 48, 9) 2025-10-02 02:48:09.947 | INFO | [Emotion fleet_1] 53 2025-10-02 02:48:09.952 | INFO | [Emotion fleet_2] 119 2025-10-02 02:48:09.956 | INFO | <<< ENTER MAP >>> 2025-10-02 02:48:10.035 | INFO | Click ( 187, 280) @ 13-1 2025-10-02 02:48:10.750 | INFO | [Map_clear_percentage] 52% 2025-10-02 02:48:11.046 | INFO | [Map_clear_percentage] 99% 2025-10-02 02:48:11.072 | INFO | [MAP_CLEAR_ALL_THIS_TIME] False 2025-10-02 02:48:11.077 | INFO | [Map_info] 99%, star_1, star_2, star_3, 100_percent_clear, 3_stars, threat_safe, clear_mode 2025-10-02 02:48:11.081 | INFO | [StopCondition_MapAchievement] non_stop 2025-10-02 02:48:11.084 | INFO | Fast_Forward set to on 2025-10-02 02:48:11.087 | INFO | [Fast_Forward] on 2025-10-02 02:48:11.102 | INFO | Auto_Search set to on 2025-10-02 02:48:11.108 | INFO | [Auto_Search] on 2025-10-02 02:48:11.112 | INFO | Click ( 863, 513) @ MAP_PREPARATION 2025-10-02 02:48:11.644 | INFO | Handling 2x book setting, mode=prep. 2025-10-02 02:48:11.670 | INFO | Using fleet: [4, 3, 1] 2025-10-02 02:48:11.750 | INFO | Hard satisfied: Fleet_1: None, Fleet_2: None, Submarine: None 2025-10-02 02:48:11.761 | INFO | [map_allow_submarine] True 2025-10-02 02:48:11.766 | INFO | Click (1052, 483) @ SUBMARINE_CHOOSE 2025-10-02 02:48:11.939 | INFO | Current selected: [1] 2025-10-02 02:48:11.947 | INFO | Click (1072, 483) @ SUBMARINE_CHOOSE 2025-10-02 02:48:12.239 | INFO | Click (1144, 326) @ FLEET_2_CLEAR 2025-10-02 02:48:12.839 | INFO | Click (1051, 223) @ FLEET_1_CHOOSE 2025-10-02 02:48:13.135 | INFO | Current selected: [4] 2025-10-02 02:48:13.138 | INFO | Click (1064, 223) @ FLEET_1_CHOOSE 2025-10-02 02:48:13.436 | INFO | Click (1048, 329) @ FLEET_2_CHOOSE 2025-10-02 02:48:13.738 | INFO | Current selected: [4] 2025-10-02 02:48:13.747 | INFO | Click (1123, 496) @ FLEET_2_BAR_INDEX_3 2025-10-02 02:48:14.046 | INFO | Auto search setting 2025-10-02 02:48:14.061 | INFO | [_fleet_sidebar_offset] 0 2025-10-02 02:48:14.066 | INFO | [Fleet_sidebar] 1/3 2025-10-02 02:48:14.069 | INFO | Click (1212, 436) @ FLEET_SIDEBAR_0_2 2025-10-02 02:48:14.575 | INFO | [_fleet_sidebar_offset] 0 2025-10-02 02:48:14.581 | INFO | [Fleet_sidebar] 3/3 2025-10-02 02:48:14.585 | INFO | [Auto_Search_Setting] fleet1_all_fleet2_standby, sub_auto_call 2025-10-02 02:48:14.589 | INFO | Click ( 501, 219) @ AUTO_SEARCH_SET_MOB 2025-10-02 02:48:15.060 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_auto_call 2025-10-02 02:48:15.065 | INFO | Selected to the correct auto search setting 2025-10-02 02:48:15.068 | INFO | [Auto_Search_Setting] fleet1_mob_fleet2_boss, sub_auto_call 2025-10-02 02:48:15.070 | INFO | Selected to the correct auto search setting 2025-10-02 02:48:15.073 | INFO | Click (1113, 563) @ FLEET_PREPARATION 2025-10-02 02:48:15.981 | INFO | is_auto_search_running appeared ────────────────────────────────────────────────────── BATTLE_0 ─────────────────────────────────────────────────────── 2025-10-02 02:48:15.987 | INFO | BATTLE_0 2025-10-02 02:48:15.989 | INFO | Auto search moving 2025-10-02 02:48:16.003 | INFO | Fleet: 1, fleet_current_index: 1 2025-10-02 02:48:16.074 | INFO | [OCR_OIL 0.068s] 5484 2025-10-02 02:48:16.174 | INFO | [OCR_COIN 0.096s] 105904 2025-10-02 02:48:22.721 | INFO | Skip map cat attack 2025-10-02 02:48:22.726 | INFO | Click (1209, 676) @ MAP_CAT_ATTACK 2025-10-02 02:48:24.528 | INFO | [Loading] 9% 2025-10-02 02:48:24.533 | INFO | Auto search combat loading 2025-10-02 02:48:24.537 | INFO | Screenshot interval set to 1.0s 2025-10-02 02:48:30.551 | INFO | [BattleUI] PAUSE 2025-10-02 02:48:30.554 | INFO | Auto Search combat execute 2025-10-02 02:48:30.557 | INFO | <<< EMOTION REDUCE >>> 2025-10-02 02:48:30.570 | INFO | Bind task ['General', 'Alas', 'Main'] 2025-10-02 02:48:30.576 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=51, Main.Emotion.Fleet1Record=datetime.datetime(2025, 10, 2, 2, 48, 30), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2025, 10, 2, 2, 48, 30) 2025-10-02 02:48:30.596 | INFO | [Emotion fleet_1] 51 2025-10-02 02:48:30.600 | INFO | [Emotion fleet_2] 119 2025-10-02 02:48:36.529 | INFO | Combat auto check timer reached 2025-10-02 02:48:50.556 | INFO | Screenshot interval set to 0.3s 2025-10-02 02:48:50.559 | INFO | Auto Search combat status 2025-10-02 02:48:53.852 | INFO | Click (1030, 655) @ GET_SHIP 2025-10-02 02:48:55.055 | INFO | Click (1029, 653) @ GET_SHIP 2025-10-02 02:48:55.942 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_1 ─────────────────────────────────────────────────────── 2025-10-02 02:48:55.948 | INFO | BATTLE_1 2025-10-02 02:48:55.951 | INFO | Auto search moving 2025-10-02 02:48:55.954 | INFO | Fleet: 1, fleet_current_index: 1 2025-10-02 02:48:56.026 | INFO | [OCR_OIL 0.069s] 5443 2025-10-02 02:48:56.103 | INFO | [OCR_COIN 0.074s] 105918 2025-10-02 02:49:02.564 | INFO | [Loading] 5% 2025-10-02 02:49:02.568 | INFO | Auto search combat loading 2025-10-02 02:49:02.571 | INFO | Screenshot interval set to 1.0s 2025-10-02 02:49:08.575 | INFO | [BattleUI] PAUSE 2025-10-02 02:49:08.578 | INFO | Auto Search combat execute 2025-10-02 02:49:08.581 | INFO | <<< EMOTION REDUCE >>> 2025-10-02 02:49:08.593 | INFO | Bind task ['General', 'Alas', 'Main'] 2025-10-02 02:49:08.597 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=49, Main.Emotion.Fleet1Record=datetime.datetime(2025, 10, 2, 2, 49, 8), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2025, 10, 2, 2, 49, 8) 2025-10-02 02:49:08.616 | INFO | [Emotion fleet_1] 49 2025-10-02 02:49:08.621 | INFO | [Emotion fleet_2] 119 2025-10-02 02:49:14.558 | INFO | Combat auto check timer reached 2025-10-02 02:49:33.592 | INFO | Screenshot interval set to 0.3s 2025-10-02 02:49:33.595 | INFO | Auto Search combat status 2025-10-02 02:49:36.288 | INFO | Click (1020, 673) @ GET_SHIP 2025-10-02 02:49:37.509 | INFO | Click (1034, 672) @ GET_SHIP 2025-10-02 02:49:38.375 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_2 ─────────────────────────────────────────────────────── 2025-10-02 02:49:38.384 | INFO | BATTLE_2 2025-10-02 02:49:38.387 | INFO | Auto search moving 2025-10-02 02:49:38.391 | INFO | Fleet: 1, fleet_current_index: 1 2025-10-02 02:49:38.473 | INFO | [OCR_OIL 0.078s] 5402 2025-10-02 02:49:38.553 | INFO | [OCR_COIN 0.077s] 105936 2025-10-02 02:49:43.793 | INFO | [Loading] 15% 2025-10-02 02:49:43.798 | INFO | Auto search combat loading 2025-10-02 02:49:43.803 | INFO | Screenshot interval set to 1.0s 2025-10-02 02:49:49.814 | INFO | [BattleUI] PAUSE 2025-10-02 02:49:49.818 | INFO | Auto Search combat execute 2025-10-02 02:49:49.823 | INFO | <<< EMOTION REDUCE >>> 2025-10-02 02:49:49.842 | INFO | Bind task ['General', 'Alas', 'Main'] 2025-10-02 02:49:49.849 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=47, Main.Emotion.Fleet1Record=datetime.datetime(2025, 10, 2, 2, 49, 49), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2025, 10, 2, 2, 49, 49) 2025-10-02 02:49:49.869 | INFO | [Emotion fleet_1] 47 2025-10-02 02:49:49.877 | INFO | [Emotion fleet_2] 119 2025-10-02 02:49:55.793 | INFO | Combat auto check timer reached 2025-10-02 02:50:17.831 | INFO | Screenshot interval set to 0.3s 2025-10-02 02:50:17.834 | INFO | Auto Search combat status 2025-10-02 02:50:20.224 | INFO | Click (1029, 650) @ GET_SHIP 2025-10-02 02:50:21.428 | INFO | Click (1021, 656) @ GET_SHIP 2025-10-02 02:50:22.616 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_3 ─────────────────────────────────────────────────────── 2025-10-02 02:50:22.625 | INFO | BATTLE_3 2025-10-02 02:50:22.630 | INFO | Auto search moving 2025-10-02 02:50:22.644 | INFO | Fleet: 1, fleet_current_index: 1 2025-10-02 02:50:22.753 | INFO | [OCR_OIL 0.103s] 5361 2025-10-02 02:50:22.853 | INFO | [OCR_COIN 0.094s] 105955 2025-10-02 02:50:27.757 | INFO | [Loading] 10% 2025-10-02 02:50:27.761 | INFO | Auto search combat loading 2025-10-02 02:50:27.765 | INFO | Screenshot interval set to 1.0s 2025-10-02 02:50:33.752 | INFO | [BattleUI] PAUSE 2025-10-02 02:50:33.758 | INFO | Auto Search combat execute 2025-10-02 02:50:33.761 | INFO | <<< EMOTION REDUCE >>> 2025-10-02 02:50:33.779 | INFO | Bind task ['General', 'Alas', 'Main'] 2025-10-02 02:50:33.798 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=45, Main.Emotion.Fleet1Record=datetime.datetime(2025, 10, 2, 2, 50, 33), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2025, 10, 2, 2, 50, 33) 2025-10-02 02:50:33.816 | INFO | [Emotion fleet_1] 45 2025-10-02 02:50:33.821 | INFO | [Emotion fleet_2] 119 2025-10-02 02:50:39.746 | INFO | Combat auto check timer reached 2025-10-02 02:51:20.810 | INFO | Click (1034, 657) @ GET_SHIP 2025-10-02 02:51:22.806 | INFO | Screenshot interval set to 0.3s 2025-10-02 02:51:22.814 | INFO | Auto Search combat status 2025-10-02 02:51:22.819 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_4 ─────────────────────────────────────────────────────── 2025-10-02 02:51:22.827 | INFO | BATTLE_4 2025-10-02 02:51:22.831 | INFO | Auto search moving 2025-10-02 02:51:22.836 | INFO | Fleet: 1, fleet_current_index: 1 2025-10-02 02:51:22.937 | INFO | [OCR_OIL 0.096s] 5338 2025-10-02 02:51:23.019 | INFO | [OCR_COIN 0.077s] 105972 2025-10-02 02:51:27.915 | INFO | [Loading] 11% 2025-10-02 02:51:27.918 | INFO | Auto search combat loading 2025-10-02 02:51:27.921 | INFO | Screenshot interval set to 1.0s 2025-10-02 02:51:33.922 | INFO | [BattleUI] PAUSE 2025-10-02 02:51:33.925 | INFO | Auto Search combat execute 2025-10-02 02:51:33.928 | INFO | <<< EMOTION REDUCE >>> 2025-10-02 02:51:33.945 | INFO | Bind task ['General', 'Alas', 'Main'] 2025-10-02 02:51:33.949 | INFO | Save config ./config/alas-pc.json, Main.Emotion.Fleet1Value=43, Main.Emotion.Fleet1Record=datetime.datetime(2025, 10, 2, 2, 51, 33), Main.Emotion.Fleet2Value=119, Main.Emotion.Fleet2Record=datetime.datetime(2025, 10, 2, 2, 51, 33) 2025-10-02 02:51:33.968 | INFO | [Emotion fleet_1] 43 2025-10-02 02:51:33.973 | INFO | [Emotion fleet_2] 119 2025-10-02 02:51:38.931 | INFO | Combat auto check timer reached 2025-10-02 02:52:23.968 | INFO | Screenshot interval set to 0.3s 2025-10-02 02:52:23.971 | INFO | Auto Search combat status 2025-10-02 02:52:25.462 | INFO | Click (1043, 658) @ GET_SHIP 2025-10-02 02:52:26.662 | INFO | Click (1023, 653) @ GET_SHIP 2025-10-02 02:52:28.765 | INFO | Click (1031, 666) @ GET_SHIP 2025-10-02 02:52:29.985 | INFO | Click (1033, 671) @ GET_SHIP 2025-10-02 02:52:30.857 | INFO | Combat end. ────────────────────────────────────────────────────── BATTLE_5 ─────────────────────────────────────────────────────── 2025-10-02 02:52:30.863 | INFO | BATTLE_5 2025-10-02 02:52:30.866 | INFO | Auto search moving 2025-10-02 02:52:30.869 | INFO | Fleet: 1, fleet_current_index: 1 2025-10-02 02:52:30.938 | INFO | [OCR_OIL 0.066s] 5315 2025-10-02 02:52:31.015 | INFO | [OCR_COIN 0.073s] 106002 2025-10-02 02:55:31.052 | 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 L1521 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 L422 run() campaign_base.py L143 run() campaign_base.py L177 auto_search_execute_a_battle() auto_search_combat.py L182 auto_search_moving() device.py L188 screenshot() device.py L250 stuck_record_check() device.py L43 show_function_call() 2025-10-02 02:55:31.081 | WARNING | Wait too long 2025-10-02 02:55:31.086 | WARNING | Waiting for {'CAMPAIGN_CHECK', 'SP_CHECK', 'PAUSE', 'EVENT_CHECK', 'GAME_TIPS3', 'AUTO_SEARCH_MAP_OPTION_OFF', 'GAME_TIPS4', 'OCR_OIL_CHECK', 'RETIRE_APPEAR_3', 'DOCK_CHECK', 'GAME_TIPS', 'FLEET_NUM_1', 'AUTO_SEARCH_MAP_OPTION_ON'} 2025-10-02 02:55:31.156 | INFO | [Package_name] com.bilibili.azurlane 2025-10-02 02:55:31.161 | ERROR | GameStuckError: Wait too long 2025-10-02 02:55:31.164 | WARNING | Saving error: ./log/error/1759344931164