Log opened at Fri, Jul 04 2025 08:49:10 UTC (actual time) Current log level is Normal ACP Expert Scheduler Engine Version 9.2.1 Part of ACP Expert 9.2.1 Full license: Arne Henden 2025-07-04 08:49:10.5: REAL TIME internal clock initialized at 04-Jul-2025 08:49:10 UTC 2025-07-04 08:49:10.5: Dispatcher started at 04-Jul-2025 08:49:10 UTC 2025-07-04 08:49:10.6: Loaded Constraint plugin AirMass 2025-07-04 08:49:10.6: Loaded Constraint plugin AirmassRange 2025-07-04 08:49:10.6: Loaded Constraint plugin Horizon 2025-07-04 08:49:10.7: Loaded Constraint plugin HourAngle 2025-07-04 08:49:10.7: Loaded Constraint plugin MoonAvoid 2025-07-04 08:49:10.7: Loaded Constraint plugin MoonDown 2025-07-04 08:49:10.7: Loaded Constraint plugin SkyCondition 2025-07-04 08:49:10.7: Loaded Constraint plugin TimeRange 2025-07-04 08:49:11.6: 194 plans are now pending. 2025-07-04 08:49:11.6: Attach ACP sequencer 2025-07-04 08:49:17.8: ++ Weather Safe ++ 2025-07-04 08:49:18.4: ==== Dispatcher is running in NORMAL (NIGHT) mode ==== 2025-07-04 08:49:18.4: Sequencer does sky flats 2025-07-04 08:50:01.3: ++ Observatory Startup ++ 2025-07-04 08:50:01.3: Weather safety is now disabled 2025-07-04 08:50:01.3: Start ACP Sequencer's StartupObs script 2025-07-04 08:51:23.8: Weather safety is re-enabled 2025-07-04 08:51:23.8: Observatory startup succeeded 2025-07-04 08:51:23.8: Periodic AF schedule reset. Interval is now 1.0 hours 2025-07-04 08:51:23.8: Last AutoFocus was completed at 29-Jun-2025 10:05:19 UTC 2025-07-04 08:51:23.8: Autofocus will be done ASAP. 2025-07-04 08:51:23.8: ++ Auto Focus ++ 2025-07-04 08:51:23.9: Doing periodic autofocus. 2025-07-04 08:51:23.9: Start special ACP AutoFocus script for scheduler 2025-07-04 08:53:32.8: ** Autofocus failed (n=1), will retry ASAP after 0 min. 2025-07-04 08:53:34.9: Plan V630_Cas has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan V884_Her has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan V2492_Cyg has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan IX_Dra has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan FY_Aql has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan V0406_Vul has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan CG_Dra has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan AZ_Cas has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan AG_Dra has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan AZ_Cas has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan B0133+47 has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan DW_Cas has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan NSV_11154 has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan RS_Sge has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan V370_And has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan V413_Aql has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan V884_Her has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan MV_Lyr has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan AE_And has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan AF_And has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan V1323_Her has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan 1RXS_J213344 has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan V0704_And has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan V0704_And__1 has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan HM_Sge has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan NGC_6535 has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan NGC_6712 has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan NGC_6864 has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan NGC_7089 has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:34.9: Plan NGC_7492 has Monitor Mode. Time to resubmit it. 2025-07-04 08:53:35.5: Plan NGC_7790 deferred, too early 2025-07-04 08:53:36.4: Dispatcher cycle time: 3.5 sec. 2025-07-04 08:53:36.4: Acquire data for Observation V0704_And... 2025-07-04 08:53:36.4: (belongs to Project AAVSO_P253_CDAG_AUTO_ver5104, Plan V0704_And) 2025-07-04 08:53:36.4: ++ Auto Focus ++ 2025-07-04 08:53:36.4: Doing periodic autofocus. 2025-07-04 08:53:36.4: Start special ACP AutoFocus script for scheduler 2025-07-04 08:55:31.2: ** Autofocus failed (n=2), will retry ASAP after 5 min. 2025-07-04 08:55:31.2: Send Observation V0704_And to ACP Sequencer 2025-07-04 08:58:26.8: ACP data acquisition failed for Observation V0704_And. 2025-07-04 08:58:26.8: (Observation V0704_And interrupted by acquisition process failure.) 2025-07-04 08:58:28.1: Dispatcher cycle time: 1.2 sec. 2025-07-04 08:58:28.1: Acquire data for Observation V0704_And... 2025-07-04 08:58:28.1: (belongs to Project AAVSO_P253_CDAG_AUTO_ver5104, Plan V0704_And__1) 2025-07-04 08:58:28.1: Send Observation V0704_And to ACP Sequencer 2025-07-04 09:05:00.5: Acquisition time: 392.3748959 sec. 2025-07-04 09:05:00.5: Data for Observation V0704_And of Plan V0704_And__1 acquired successfully. 2025-07-04 09:05:00.5: Plan V0704_And__1 completed successfully. 2025-07-04 09:05:00.5: Image Efficiency: 54.9% 2025-07-04 09:05:00.5: Cycle Efficiency: 99.7% 2025-07-04 09:05:00.6: ++ Auto Focus ++ 2025-07-04 09:05:00.6: Doing periodic autofocus. 2025-07-04 09:05:00.6: Start special ACP AutoFocus script for scheduler 2025-07-04 09:12:28.9: ** Autofocus failed (n=3), will retry ASAP after 10 min. 2025-07-04 09:12:29.8: Dispatcher cycle time: 0.9 sec. 2025-07-04 09:12:29.8: Acquire data for Observation FY_Aql... 2025-07-04 09:12:29.8: (belongs to Project AAVSO_P192_SFRA_AUTO_ver2413, Plan FY_Aql) 2025-07-04 09:12:29.8: Send Observation FY_Aql to ACP Sequencer 2025-07-04 09:18:50.6: ACP data acquisition failed for Observation FY_Aql. 2025-07-04 09:18:50.6: (Observation FY_Aql interrupted by acquisition process failure.) 2025-07-04 09:18:51.6: Dispatcher cycle time: 0.9 sec. 2025-07-04 09:18:51.6: Acquire data for Observation MV_Lyr... 2025-07-04 09:18:51.6: (belongs to Project AAVSO_P233_DKS_AUTO_ver2623, Plan MV_Lyr) 2025-07-04 09:18:51.6: Send Observation MV_Lyr to ACP Sequencer 2025-07-04 09:20:38.8: ACP data acquisition failed for Observation MV_Lyr. 2025-07-04 09:20:38.8: (Observation MV_Lyr interrupted by acquisition process failure.) 2025-07-04 09:20:39.8: Dispatcher cycle time: 0.9 sec. 2025-07-04 09:20:39.8: Acquire data for Observation V0406_Vul... 2025-07-04 09:20:39.8: (belongs to Project AAVSO_P194_BPEC_AUTO_ver2706, Plan V0406_Vul) 2025-07-04 09:20:39.8: Send Observation V0406_Vul to ACP Sequencer 2025-07-04 09:27:04.6: ACP data acquisition failed for Observation V0406_Vul. 2025-07-04 09:27:04.6: (Observation V0406_Vul interrupted by acquisition process failure.) 2025-07-04 09:27:04.8: ++ Auto Focus ++ 2025-07-04 09:27:04.8: Doing periodic autofocus. 2025-07-04 09:27:04.8: Start special ACP AutoFocus script for scheduler 2025-07-04 09:29:21.1: ** Autofocus failed (n=4), will retry ASAP after 15 min. 2025-07-04 09:29:22.0: Dispatcher cycle time: 0.9 sec. 2025-07-04 09:29:22.0: Acquire data for Observation IX_Dra... 2025-07-04 09:29:22.0: (belongs to Project AAVSO_P153_SFY_AUTO_ver2706, Plan IX_Dra) 2025-07-04 09:29:22.0: Send Observation IX_Dra to ACP Sequencer 2025-07-04 09:31:36.0: ACP data acquisition failed for Observation IX_Dra. 2025-07-04 09:31:36.0: (Observation IX_Dra interrupted by acquisition process failure.) 2025-07-04 09:31:37.0: Dispatcher cycle time: 0.8 sec. 2025-07-04 09:31:37.0: Acquire data for Observation NGC_6535... 2025-07-04 09:31:37.0: (belongs to Project AAVSO_MISC_Welch_AUTO_ver5271, Plan NGC_6535) 2025-07-04 09:31:37.0: Send Observation NGC_6535 to ACP Sequencer 2025-07-04 09:34:40.2: ACP data acquisition failed for Observation NGC_6535. 2025-07-04 09:34:40.2: (Observation NGC_6535 interrupted by acquisition process failure.) 2025-07-04 09:34:41.2: Dispatcher cycle time: 0.8 sec. 2025-07-04 09:34:41.2: Acquire data for Observation V884_Her... 2025-07-04 09:34:41.2: (belongs to Project AAVSO_MISC_PYG_AUTO_ver3260, Plan V884_Her) 2025-07-04 09:34:41.2: Send Observation V884_Her to ACP Sequencer 2025-07-04 09:36:41.1: ACP data acquisition failed for Observation V884_Her. 2025-07-04 09:36:41.1: (Observation V884_Her interrupted by acquisition process failure.) 2025-07-04 09:36:42.1: Dispatcher cycle time: 0.9 sec. 2025-07-04 09:36:42.1: Acquire data for Observation V630_Cas... 2025-07-04 09:36:42.1: (belongs to Project AAVSO_MISC_PYG_AUTO_ver3260, Plan V630_Cas) 2025-07-04 09:36:42.1: Send Observation V630_Cas to ACP Sequencer 2025-07-04 09:40:05.3: ACP data acquisition failed for Observation V630_Cas. 2025-07-04 09:40:05.3: (Observation V630_Cas interrupted by acquisition process failure.) 2025-07-04 09:40:06.2: Dispatcher cycle time: 0.8 sec. 2025-07-04 09:40:06.2: Acquire data for Observation AE_And... 2025-07-04 09:40:06.2: (belongs to Project AAVSO_P251_MSD_AUTO_ver2819, Plan AE_And) 2025-07-04 09:40:06.2: Send Observation AE_And to ACP Sequencer 2025-07-04 09:41:46.4: ACP data acquisition failed for Observation AE_And. 2025-07-04 09:41:46.4: (Observation AE_And interrupted by acquisition process failure.) 2025-07-04 09:41:47.3: Dispatcher cycle time: 0.8 sec. 2025-07-04 09:41:47.3: Acquire data for Observation HM_Sge... 2025-07-04 09:41:47.3: (belongs to Project AAVSO_P595_GSAD_AUTO_ver5110, Plan HM_Sge) 2025-07-04 09:41:47.4: Send Observation HM_Sge to ACP Sequencer 2025-07-04 10:16:45.7: Acquisition time: 2098.2961962 sec. 2025-07-04 10:16:45.7: Data for Observation HM_Sge of Plan HM_Sge acquired successfully. 2025-07-04 10:16:45.7: Plan HM_Sge completed successfully. 2025-07-04 10:16:45.7: Image Efficiency: 67.2% 2025-07-04 10:16:45.7: Cycle Efficiency: 100.0% 2025-07-04 10:16:45.8: ++ Auto Focus ++ 2025-07-04 10:16:45.8: Doing periodic autofocus. 2025-07-04 10:16:45.8: Start special ACP AutoFocus script for scheduler 2025-07-04 10:21:19.3: Next periodic autofocus ASAP after 3600sec. 04-Jul-2025 11:20:55 UTC 2025-07-04 10:21:20.1: Dispatcher cycle time: 0.8 sec. 2025-07-04 10:21:20.1: Acquire data for Observation V2492_Cyg... 2025-07-04 10:21:20.1: (belongs to Project AAVSO_MISC_SGUA_AUTO_ver2821, Plan V2492_Cyg) 2025-07-04 10:21:20.1: Send Observation V2492_Cyg to ACP Sequencer 2025-07-04 10:25:40.5: ACP data acquisition failed for Observation V2492_Cyg. 2025-07-04 10:25:40.5: (Observation V2492_Cyg interrupted by acquisition process failure.) 2025-07-04 10:25:41.4: Dispatcher cycle time: 0.8 sec. 2025-07-04 10:25:41.4: Acquire data for Observation AF_And... 2025-07-04 10:25:41.4: (belongs to Project AAVSO_P251_MSD_AUTO_ver2819, Plan AF_And) 2025-07-04 10:25:41.4: Send Observation AF_And to ACP Sequencer 2025-07-04 10:27:58.2: ACP data acquisition failed for Observation AF_And. 2025-07-04 10:27:58.2: (Observation AF_And interrupted by acquisition process failure.) 2025-07-04 10:27:59.1: Dispatcher cycle time: 0.7 sec. 2025-07-04 10:27:59.1: Acquire data for Observation NGC_7492... 2025-07-04 10:27:59.1: (belongs to Project AAVSO_MISC_Welch_AUTO_ver5271, Plan NGC_7492) 2025-07-04 10:27:59.1: Send Observation NGC_7492 to ACP Sequencer 2025-07-04 10:30:08.5: ACP data acquisition failed for Observation NGC_7492. 2025-07-04 10:30:08.5: (Observation NGC_7492 interrupted by acquisition process failure.) 2025-07-04 10:30:09.4: Dispatcher cycle time: 0.8 sec. 2025-07-04 10:30:09.4: Acquire data for Observation 1RXS_J213344... 2025-07-04 10:30:09.4: (belongs to Project AAVSO_P520_MMAE_AUTO_ver4555, Plan 1RXS_J213344) 2025-07-04 10:30:09.4: Send Observation 1RXS_J213344 to ACP Sequencer 2025-07-04 10:32:50.2: ACP data acquisition failed for Observation 1RXS_J213344. 2025-07-04 10:32:50.2: (Observation 1RXS_J213344 interrupted by acquisition process failure.) 2025-07-04 10:32:51.0: Dispatcher cycle time: 0.7 sec. 2025-07-04 10:32:51.0: Acquire data for Observation NGC_7089... 2025-07-04 10:32:51.0: (belongs to Project AAVSO_MISC_Welch_AUTO_ver5271, Plan NGC_7089) 2025-07-04 10:32:51.0: Send Observation NGC_7089 to ACP Sequencer 2025-07-04 10:36:49.1: ACP data acquisition failed for Observation NGC_7089. 2025-07-04 10:36:49.1: (Observation NGC_7089 interrupted by acquisition process failure.) 2025-07-04 10:36:49.9: Dispatcher cycle time: 0.7 sec. 2025-07-04 10:36:49.9: Acquire data for Observation V1323_Her... 2025-07-04 10:36:49.9: (belongs to Project AAVSO_P518_MMAE_AUTO_ver4553, Plan V1323_Her) 2025-07-04 10:36:50.3: Send Observation V1323_Her to ACP Sequencer 2025-07-04 10:39:51.9: ACP data acquisition failed for Observation V1323_Her. 2025-07-04 10:39:51.9: (Observation V1323_Her interrupted by acquisition process failure.) 2025-07-04 10:39:52.7: Dispatcher cycle time: 0.6 sec. 2025-07-04 10:39:52.7: Acquire data for Observation AZ_Cas... 2025-07-04 10:39:52.7: (belongs to Project AAVSO_MISC_HQA_AUTO_ver5104, Plan AZ_Cas) 2025-07-04 10:39:52.7: Send Observation AZ_Cas to ACP Sequencer 2025-07-04 10:43:39.9: Acquisition time: 227.1392189 sec. 2025-07-04 10:43:39.9: Data for Observation AZ_Cas of Plan AZ_Cas acquired successfully. 2025-07-04 10:43:39.9: Plan AZ_Cas completed successfully. 2025-07-04 10:43:39.9: Image Efficiency: 13.2% 2025-07-04 10:43:39.9: Cycle Efficiency: 99.7% 2025-07-04 10:43:40.6: Dispatcher cycle time: 0.6 sec. 2025-07-04 10:43:40.6: Acquire data for Observation CG_Dra... 2025-07-04 10:43:40.6: (belongs to Project AAVSO_P211_BENS_AUTO_ver2706, Plan CG_Dra) 2025-07-04 10:43:40.6: Send Observation CG_Dra to ACP Sequencer 2025-07-04 10:50:29.2: ACP data acquisition failed for Observation CG_Dra. 2025-07-04 10:50:29.2: (Observation CG_Dra interrupted by acquisition process failure.) 2025-07-04 10:50:29.8: Dispatcher cycle time: 0.5 sec. 2025-07-04 10:50:29.8: Acquire data for Observation V504_Per... 2025-07-04 10:50:29.8: (belongs to Project AAVSO_survey_HQ_AUTO_ver5104, Plan V504_Per) 2025-07-04 10:50:29.8: Send Observation V504_Per to ACP Sequencer 2025-07-04 10:58:06.9: ACP data acquisition failed for Observation V504_Per. 2025-07-04 10:58:06.9: (Observation V504_Per interrupted by acquisition process failure.) 2025-07-04 10:58:07.3: Dispatcher cycle time: 0.2 sec. 2025-07-04 10:58:07.3: Acquire data for Observation V370_And... 2025-07-04 10:58:07.3: (belongs to Project AAVSO_survey_HQ_AUTO_ver5104, Plan V370_And) 2025-07-04 10:58:07.3: Send Observation V370_And to ACP Sequencer 2025-07-04 11:00:57.3: Acquisition time: 170.0522364 sec. 2025-07-04 11:00:57.3: Data for Observation V370_And of Plan V370_And acquired successfully. 2025-07-04 11:00:57.3: Plan V370_And completed successfully. 2025-07-04 11:00:57.4: Image Efficiency: 11.7% 2025-07-04 11:00:57.4: Cycle Efficiency: 99.9% 2025-07-04 11:00:57.6: Dispatcher cycle time: 0.1 sec. 2025-07-04 11:00:57.6: Acquire data for Observation AZ_Cas... 2025-07-04 11:00:57.6: (belongs to Project AAVSO_survey_HQ_AUTO_ver5104, Plan AZ_Cas) 2025-07-04 11:00:57.6: Send Observation AZ_Cas to ACP Sequencer 2025-07-04 11:03:49.7: Acquisition time: 172.0560158 sec. 2025-07-04 11:03:49.7: Data for Observation AZ_Cas of Plan AZ_Cas acquired successfully. 2025-07-04 11:03:49.7: Plan AZ_Cas completed successfully. 2025-07-04 11:03:49.7: Image Efficiency: 14.5% 2025-07-04 11:03:49.7: Cycle Efficiency: 99.9% 2025-07-04 11:17:31.5: ++ Dawn Flats ++ 2025-07-04 11:17:31.6: Start ACP AutoFlat script for Dawn flats 2025-07-04 12:06:27.3: -- Observatory Shutdown -- 2025-07-04 12:06:27.3: Weather safety is now disabled 2025-07-04 12:06:27.3: Start ACP Sequencer's ShutdownObs script 2025-07-04 12:07:40.5: Weather safety is re-enabled 2025-07-04 12:07:40.8: Run statistics: 2025-07-04 12:07:40.8: Observations: 298 2025-07-04 12:07:40.8: Considered: 106 2025-07-04 12:07:40.8: Completed: 5 2025-07-04 12:07:40.8: Skipped: 78 2025-07-04 12:07:40.8: Never Eligible: 192 2025-07-04 12:07:40.8: Failed: 23 2025-07-04 12:07:40.8: Shutter-Open efficiency: 24.45% 2025-07-04 12:07:40.8: Overall Efficiency: 98.06% 2025-07-04 12:10:50.0: Requested shutdown of scheduler 2025-07-04 12:10:50.1: ++ EARLY SHUTDOWN ++ 2025-07-04 12:10:50.3: Run statistics: 2025-07-04 12:10:50.3: Observations: 298 2025-07-04 12:10:50.3: Considered: 28 2025-07-04 12:10:50.3: Completed: 5 2025-07-04 12:10:50.3: Skipped: 0 2025-07-04 12:10:50.3: Never Eligible: 270 2025-07-04 12:10:50.3: Failed: 23 2025-07-04 12:10:50.3: Shutter-Open efficiency: 24.45% 2025-07-04 12:10:50.3: Overall Efficiency: 98.06% 2025-07-04 12:10:50.3: Release ACP sequencer Log closed at Fri, Jul 04 2025 12:10:51 UTC (actual time)