2015-02-13T00:23:06.990Z,1423786986.990 [Supervisor](DEBUG): Initializing supervisor.
2015-02-13T00:23:06.993Z,1423786986.993 [SyncHandler](DEBUG): Created PCaller Thread at 4034C4E0
2015-02-13T00:23:06.993Z,1423786986.993 [SyncHandler](INFO): Protected caller Thread ID is 1054
2015-02-13T00:23:06.994Z,1423786986.994 [ComponentRegistry](DEBUG): Component "controlThread" handled in its own thread.
2015-02-13T00:23:06.995Z,1423786986.995 [controlThread ThreadHandler](DEBUG): Created PCaller Thread at 4037C4E0
2015-02-13T00:23:06.995Z,1423786986.995 [controlThread ThreadHandler](INFO): Protected caller Thread ID is 1055
2015-02-13T00:23:06.998Z,1423786986.998 [ComponentRegistry](DEBUG): SyncComponent "CycleStarter" handled in the control thread.
2015-02-13T00:23:07.009Z,1423786987.009 [ComponentRegistry](DEBUG): Component "CommandLine" handled in its own thread.
2015-02-13T00:23:07.011Z,1423786987.011 [CommandLine ThreadHandler](DEBUG): Created PCaller Thread at 403AC4E0
2015-02-13T00:23:07.011Z,1423786987.011 [CommandLine ThreadHandler](INFO): Protected caller Thread ID is 1056
2015-02-13T00:23:07.012Z,1423786987.012 [ComponentRegistry](DEBUG): Component "logger" handled in its own thread.
2015-02-13T00:23:07.013Z,1423786987.013 [logger ThreadHandler](DEBUG): Created PCaller Thread at 403DC4E0
2015-02-13T00:23:07.013Z,1423786987.013 [logger ThreadHandler](INFO): Protected caller Thread ID is 1057
2015-02-13T00:23:07.015Z,1423786987.015 [ComponentRegistry](DEBUG): SyncComponent "LogSplitter" handled in the control thread.
2015-02-13T00:23:07.016Z,1423786987.016 [Supervisor](INFO): Looking for Config files in directory: Config/
2015-02-13T00:23:07.017Z,1423786987.017 [Supervisor](INFO): Opening Config file at: Config/Control.cfg
2015-02-13T00:23:07.338Z,1423786987.338 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Control
2015-02-13T00:23:07.339Z,1423786987.339 [Supervisor](INFO): Opening Config file at: Config/BIT.cfg
2015-02-13T00:23:07.499Z,1423786987.499 [ComponentRegistry](DEBUG): Loaded Config Component "Config/BIT
2015-02-13T00:23:07.500Z,1423786987.500 [Supervisor](INFO): Opening Config file at: Config/Derivation.cfg
2015-02-13T00:23:07.607Z,1423786987.607 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Derivation
2015-02-13T00:23:07.608Z,1423786987.608 [Supervisor](INFO): Opening Config file at: Config/Estimation.cfg
2015-02-13T00:23:07.730Z,1423786987.730 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Estimation
2015-02-13T00:23:07.730Z,1423786987.730 [Supervisor](INFO): Opening Config file at: Config/Guidance.cfg
2015-02-13T00:23:07.814Z,1423786987.814 [Supervisor](INFO): Opening Config file at: Config/Navigation.cfg
2015-02-13T00:23:07.973Z,1423786987.973 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Navigation
2015-02-13T00:23:07.974Z,1423786987.974 [Supervisor](INFO): Opening Config file at: Config/Sample.cfg
2015-02-13T00:23:08.059Z,1423786988.059 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sample
2015-02-13T00:23:08.059Z,1423786988.059 [Supervisor](INFO): Opening Config file at: Config/Science.cfg
2015-02-13T00:23:08.266Z,1423786988.266 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Science
2015-02-13T00:23:08.267Z,1423786988.267 [Supervisor](INFO): Opening Config file at: Config/Sensor.cfg
2015-02-13T00:23:08.620Z,1423786988.620 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sensor
2015-02-13T00:23:08.620Z,1423786988.620 [Supervisor](INFO): Opening Config file at: Config/Servo.cfg
2015-02-13T00:23:08.923Z,1423786988.923 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Servo
2015-02-13T00:23:08.924Z,1423786988.924 [Supervisor](INFO): Opening Config file at: Config/Simulator.cfg
2015-02-13T00:23:09.413Z,1423786989.413 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Simulator
2015-02-13T00:23:09.413Z,1423786989.413 [Supervisor](INFO): Opening Config file at: Config/logger.cfg
2015-02-13T00:23:09.644Z,1423786989.644 [ComponentRegistry](DEBUG): Loaded Config Component "Config/logger
2015-02-13T00:23:09.645Z,1423786989.645 [Supervisor](INFO): Opening Config file at: Config/secure.cfg
2015-02-13T00:23:09.748Z,1423786989.748 [ComponentRegistry](DEBUG): Loaded Config Component "Config/secure
2015-02-13T00:23:09.749Z,1423786989.749 [Supervisor](INFO): Opening Config file at: Config/vehicle.cfg
2015-02-13T00:23:10.158Z,1423786990.158 [ComponentRegistry](DEBUG): Loaded Config Component "Config/vehicle
2015-02-13T00:23:10.159Z,1423786990.159 [Supervisor](INFO): Opening Config file at: Config/workSite.cfg
2015-02-13T00:23:10.269Z,1423786990.269 [ComponentRegistry](DEBUG): Loaded Config Component "Config/workSite
2015-02-13T00:23:10.271Z,1423786990.271 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-makai/
2015-02-13T00:23:10.272Z,1423786990.272 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Battery.cfg
2015-02-13T00:23:10.510Z,1423786990.510 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Battery
2015-02-13T00:23:10.511Z,1423786990.511 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/BIT.cfg
2015-02-13T00:23:10.626Z,1423786990.626 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Estimation.cfg
2015-02-13T00:23:10.722Z,1423786990.722 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Control.cfg
2015-02-13T00:23:10.818Z,1423786990.818 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Navigation.cfg
2015-02-13T00:23:10.924Z,1423786990.924 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Science.cfg
2015-02-13T00:23:11.064Z,1423786991.064 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Sensor.cfg
2015-02-13T00:23:11.244Z,1423786991.244 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Servo.cfg
2015-02-13T00:23:11.345Z,1423786991.345 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Simulator.cfg
2015-02-13T00:23:11.435Z,1423786991.435 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/logger.cfg
2015-02-13T00:23:11.534Z,1423786991.534 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/secure.cfg
2015-02-13T00:23:11.630Z,1423786991.630 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/vehicle.cfg
2015-02-13T00:23:11.810Z,1423786991.810 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-makai/root/
2015-02-13T00:23:11.811Z,1423786991.811 [Supervisor](IMPORTANT): Reading configuration overrides from Data/persisted.cfg
2015-02-13T00:23:11.824Z,1423786991.824 [Module Loader](DEBUG): Loading Module at Modules/Control.so
2015-02-13T00:23:11.876Z,1423786991.876 [VerticalControl](DEBUG): Construct VerticalControl.
2015-02-13T00:23:11.997Z,1423786991.997 [VerticalControl] Loaded
2015-02-13T00:23:11.997Z,1423786991.997 [ComponentRegistry](DEBUG): SyncComponent "VerticalControl" handled in the control thread.
2015-02-13T00:23:11.998Z,1423786991.998 [HorizontalControl](DEBUG): Construct HorizontalControl.
2015-02-13T00:23:12.072Z,1423786992.072 [HorizontalControl] Loaded
2015-02-13T00:23:12.072Z,1423786992.072 [ComponentRegistry](DEBUG): SyncComponent "HorizontalControl" handled in the control thread.
2015-02-13T00:23:12.073Z,1423786992.073 [SpeedControl](DEBUG): Construct SpeedControl.
2015-02-13T00:23:12.079Z,1423786992.079 [SpeedControl] Loaded
2015-02-13T00:23:12.079Z,1423786992.079 [ComponentRegistry](DEBUG): SyncComponent "SpeedControl" handled in the control thread.
2015-02-13T00:23:12.080Z,1423786992.080 [LoopControl](DEBUG): Construct LoopControl.
2015-02-13T00:23:12.080Z,1423786992.080 [LoopControl] Loaded
2015-02-13T00:23:12.080Z,1423786992.080 [ComponentRegistry](DEBUG): SyncComponent "LoopControl" handled in the control thread.
2015-02-13T00:23:12.081Z,1423786992.081 [Module Loader](DEBUG): Loaded Module: Control (Contains the Control components, such as Depth, Heading, and Speed Control)
2015-02-13T00:23:12.081Z,1423786992.081 [Module Loader](DEBUG): Loading Module at Modules/BIT.so
2015-02-13T00:23:12.205Z,1423786992.205 [SBIT](DEBUG): Construct Startup Built In Test.
2015-02-13T00:23:12.216Z,1423786992.216 [SBIT] Loaded
2015-02-13T00:23:12.217Z,1423786992.217 [ComponentRegistry](DEBUG): SyncComponent "SBIT" handled in the control thread.
2015-02-13T00:23:12.217Z,1423786992.217 [IBIT](DEBUG): Construct Initiated Built In Test.
2015-02-13T00:23:12.247Z,1423786992.247 [IBIT] Loaded
2015-02-13T00:23:12.247Z,1423786992.247 [ComponentRegistry](DEBUG): SyncComponent "IBIT" handled in the control thread.
2015-02-13T00:23:12.249Z,1423786992.249 [CBIT](DEBUG): Construct CBIT Built In Test.
2015-02-13T00:23:12.384Z,1423786992.384 [CBIT] Loaded
2015-02-13T00:23:12.384Z,1423786992.384 [ComponentRegistry](DEBUG): SyncComponent "CBIT" handled in the control thread.
2015-02-13T00:23:12.384Z,1423786992.384 [Module Loader](DEBUG): Loaded Module: BIT (Contains the BuiltInTest components, such as C Built In Test)
2015-02-13T00:23:12.385Z,1423786992.385 [Module Loader](DEBUG): Loading Module at Modules/Derivation.so
2015-02-13T00:23:12.404Z,1423786992.404 [DepthRateCalculator] Loaded
2015-02-13T00:23:12.404Z,1423786992.404 [ComponentRegistry](DEBUG): SyncComponent "DepthRateCalculator" handled in the control thread.
2015-02-13T00:23:12.410Z,1423786992.410 [PitchRateCalculator] Loaded
2015-02-13T00:23:12.410Z,1423786992.410 [ComponentRegistry](DEBUG): SyncComponent "PitchRateCalculator" handled in the control thread.
2015-02-13T00:23:12.422Z,1423786992.422 [SpeedCalculator] Loaded
2015-02-13T00:23:12.422Z,1423786992.422 [ComponentRegistry](DEBUG): SyncComponent "SpeedCalculator" handled in the control thread.
2015-02-13T00:23:12.439Z,1423786992.439 [TempGradientCalculator] Loaded
2015-02-13T00:23:12.439Z,1423786992.439 [ComponentRegistry](DEBUG): SyncComponent "TempGradientCalculator" handled in the control thread.
2015-02-13T00:23:12.445Z,1423786992.445 [YawRateCalculator] Loaded
2015-02-13T00:23:12.445Z,1423786992.445 [ComponentRegistry](DEBUG): SyncComponent "YawRateCalculator" handled in the control thread.
2015-02-13T00:23:12.445Z,1423786992.445 [Module Loader](DEBUG): Loaded Module: Derivation (Contains the base derivation components)
2015-02-13T00:23:12.446Z,1423786992.446 [Module Loader](DEBUG): Loading Module at Modules/Estimation.so
2015-02-13T00:23:13.477Z,1423786993.477 [HFRCMReconstructedInterpolator] Loaded
2015-02-13T00:23:13.477Z,1423786993.477 [ComponentRegistry](DEBUG): SyncComponent "HFRCMReconstructedInterpolator" handled in the control thread.
2015-02-13T00:23:13.478Z,1423786993.478 [Module Loader](DEBUG): Loaded Module: Estimation (Contains the base estimation components)
2015-02-13T00:23:13.478Z,1423786993.478 [Module Loader](DEBUG): Loading Module at Modules/Guidance.so
2015-02-13T00:23:13.717Z,1423786993.717 [Module Loader](DEBUG): Loaded Module: Guidance (Contains behaviors and commands)
2015-02-13T00:23:13.718Z,1423786993.718 [Module Loader](DEBUG): Loading Module at Modules/Navigation.so
2015-02-13T00:23:13.804Z,1423786993.804 [DeadReckonUsingMultipleVelocitySources] Loaded
2015-02-13T00:23:13.805Z,1423786993.805 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingMultipleVelocitySources" handled in the control thread.
2015-02-13T00:23:13.852Z,1423786993.852 [DeadReckonUsingSpeedCalculator] Loaded
2015-02-13T00:23:13.853Z,1423786993.853 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingSpeedCalculator" handled in the control thread.
2015-02-13T00:23:13.870Z,1423786993.870 [NavChart] Loaded
2015-02-13T00:23:13.871Z,1423786993.871 [ComponentRegistry](DEBUG): SyncComponent "NavChart" handled in the control thread.
2015-02-13T00:23:13.875Z,1423786993.875 [UniversalFixResidualReporter] Loaded
2015-02-13T00:23:13.875Z,1423786993.875 [ComponentRegistry](DEBUG): SyncComponent "UniversalFixResidualReporter" handled in the control thread.
2015-02-13T00:23:13.876Z,1423786993.876 [Module Loader](DEBUG): Loaded Module: Navigation (Contains the base navigation components)
2015-02-13T00:23:13.876Z,1423786993.876 [Module Loader](DEBUG): Loading Module at Modules/Sample.so
2015-02-13T00:23:13.882Z,1423786993.882 [Module Loader](DEBUG): Loaded Module: Sample (This is a Sample Module of Sample Components)
2015-02-13T00:23:13.883Z,1423786993.883 [Module Loader](DEBUG): Loading Module at Modules/Science.so
2015-02-13T00:23:13.991Z,1423786993.991 [Module Loader](DEBUG): Loaded Module: Science (Contains the science components)
2015-02-13T00:23:13.991Z,1423786993.991 [Module Loader](DEBUG): Loading Module at Modules/Sensor.so
2015-02-13T00:23:14.300Z,1423786994.300 [DataOverHttps] Loaded
2015-02-13T00:23:14.301Z,1423786994.301 [ComponentRegistry](DEBUG): SyncComponent "DataOverHttps" handled in the control thread.
2015-02-13T00:23:14.381Z,1423786994.381 [Depth_Keller] Loaded
2015-02-13T00:23:14.382Z,1423786994.382 [ComponentRegistry](DEBUG): SyncComponent "Depth_Keller" handled in the control thread.
2015-02-13T00:23:14.479Z,1423786994.479 [NAL9602] Loaded
2015-02-13T00:23:14.479Z,1423786994.479 [ComponentRegistry](DEBUG): SyncComponent "NAL9602" handled in the control thread.
2015-02-13T00:23:14.522Z,1423786994.522 [Onboard] Loaded
2015-02-13T00:23:14.522Z,1423786994.522 [ComponentRegistry](DEBUG): SyncComponent "Onboard" handled in the control thread.
2015-02-13T00:23:14.529Z,1423786994.529 [Radio_Surface] Loaded
2015-02-13T00:23:14.530Z,1423786994.530 [ComponentRegistry](DEBUG): Component "Radio_Surface" handled in its own thread.
2015-02-13T00:23:14.531Z,1423786994.531 [Radio_Surface ThreadHandler](DEBUG): Created PCaller Thread at 408074E0
2015-02-13T00:23:14.531Z,1423786994.531 [Radio_Surface ThreadHandler](INFO): Protected caller Thread ID is 1139
2015-02-13T00:23:14.582Z,1423786994.582 [PNI_TCM] Loaded
2015-02-13T00:23:14.582Z,1423786994.582 [ComponentRegistry](DEBUG): SyncComponent "PNI_TCM" handled in the control thread.
2015-02-13T00:23:16.537Z,1423786996.537 [BPC1] Loaded
2015-02-13T00:23:16.537Z,1423786996.537 [ComponentRegistry](DEBUG): SyncComponent "BPC1" handled in the control thread.
2015-02-13T00:23:16.538Z,1423786996.538 [Module Loader](DEBUG): Loaded Module: Sensor (Contains the sensor components)
2015-02-13T00:23:16.538Z,1423786996.538 [Module Loader](DEBUG): Loading Module at Modules/Servo.so
2015-02-13T00:23:16.641Z,1423786996.641 [BuoyancyServo] Loaded
2015-02-13T00:23:16.641Z,1423786996.641 [ComponentRegistry](DEBUG): SyncComponent "BuoyancyServo" handled in the control thread.
2015-02-13T00:23:16.654Z,1423786996.654 [ElevatorServo] Loaded
2015-02-13T00:23:16.654Z,1423786996.654 [ComponentRegistry](DEBUG): SyncComponent "ElevatorServo" handled in the control thread.
2015-02-13T00:23:16.666Z,1423786996.666 [MassServo] Loaded
2015-02-13T00:23:16.667Z,1423786996.667 [ComponentRegistry](DEBUG): SyncComponent "MassServo" handled in the control thread.
2015-02-13T00:23:16.679Z,1423786996.679 [RudderServo] Loaded
2015-02-13T00:23:16.679Z,1423786996.679 [ComponentRegistry](DEBUG): SyncComponent "RudderServo" handled in the control thread.
2015-02-13T00:23:16.691Z,1423786996.691 [ThrusterServo] Loaded
2015-02-13T00:23:16.691Z,1423786996.691 [ComponentRegistry](DEBUG): SyncComponent "ThrusterServo" handled in the control thread.
2015-02-13T00:23:16.692Z,1423786996.692 [Module Loader](DEBUG): Loaded Module: Servo (This is the module containing motor controllers)
2015-02-13T00:23:16.692Z,1423786996.692 [Module Loader](DEBUG): Loading Module at Modules/Simulator.so
2015-02-13T00:23:16.935Z,1423786996.935 [ExternalSim] Loaded
2015-02-13T00:23:16.935Z,1423786996.935 [ComponentRegistry](DEBUG): SyncComponent "ExternalSim" handled in the control thread.
2015-02-13T00:23:16.936Z,1423786996.936 [Module Loader](DEBUG): Loaded Module: Simulator (This is the module containing the Simulator)
2015-02-13T00:23:16.936Z,1423786996.936 [Module Loader](DEBUG): Loading Module at Modules/Trigger.so
2015-02-13T00:23:16.960Z,1423786996.960 [Module Loader](DEBUG): Loaded Module: Trigger (Contains triggers for use in missions)
2015-02-13T00:23:16.962Z,1423786996.962 [ComponentRegistry](DEBUG): SyncComponent "MissionManager" handled in the control thread.
2015-02-13T00:23:16.963Z,1423786996.963 [ComponentRegistry](DEBUG): SyncComponent "Reporter" handled in the control thread.
2015-02-13T00:23:16.970Z,1423786996.970 [ComponentRegistry](DEBUG): Component "NavChartDb" handled in its own thread.
2015-02-13T00:23:16.971Z,1423786996.971 [NavChartDb ThreadHandler](DEBUG): Created PCaller Thread at 408B84E0
2015-02-13T00:23:16.971Z,1423786996.971 [NavChartDb ThreadHandler](INFO): Protected caller Thread ID is 1140
2015-02-13T00:23:16.976Z,1423786996.976 [Supervisor](INFO): Main Thread ID is 941
2015-02-13T00:23:16.976Z,1423786996.976 [Supervisor](DEBUG): Running supervisor.
2015-02-13T00:23:16.977Z,1423786996.977 [CommandLine ThreadHandler](INFO): Handler Thread ID is 1141
2015-02-13T00:23:16.981Z,1423786996.981 [controlThread ThreadHandler](INFO): Handler Thread ID is 1142
2015-02-13T00:23:16.982Z,1423786996.982 [controlThread](DEBUG): Initializing ControlThread
2015-02-13T00:23:16.983Z,1423786996.983 [VerticalControl](DEBUG): Initialize VerticalControlComponent.
2015-02-13T00:23:16.984Z,1423786996.984 [HorizontalControl](DEBUG): Initialize HorizontalControlComponent.
2015-02-13T00:23:16.985Z,1423786996.985 [SpeedControl](DEBUG): Initialize SpeedControlComponent.
2015-02-13T00:23:16.986Z,1423786996.986 [LoopControl](DEBUG): Initialize LoopControlComponent.
2015-02-13T00:23:16.986Z,1423786996.986 [SBIT](INFO): Initialize SBIT Component.
2015-02-13T00:23:16.986Z,1423786996.986 [SBIT](IMPORTANT): Tethys CM Info: SVN revision:12012
2015-02-13T00:23:16.987Z,1423786996.987 [SBIT](IMPORTANT): Kernel Release: 2.6.27.8
2015-02-13T00:23:16.987Z,1423786996.987 [SBIT](IMPORTANT): Kernel Version:#639 PREEMPT Wed Mar 12 12:53:33 PDT 2014
2015-02-13T00:23:16.988Z,1423786996.988 [IBIT](INFO): Initialize IBIT Component.
2015-02-13T00:23:16.989Z,1423786996.989 [CBIT](DEBUG): Initialize CBIT Component.
2015-02-13T00:23:16.989Z,1423786996.989 [CBIT](INFO): Last reboot was NOT due to watchdog timer.
2015-02-13T00:23:16.990Z,1423786996.990 [logger ThreadHandler](INFO): Handler Thread ID is 1143
2015-02-13T00:23:17.010Z,1423786997.010 [Radio_Surface ThreadHandler](INFO): Handler Thread ID is 1144
2015-02-13T00:23:17.014Z,1423786997.014 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
2015-02-13T00:23:17.014Z,1423786997.014 [PitchRateCalculator](DEBUG): Initializing PitchRateCalculator.
2015-02-13T00:23:17.015Z,1423786997.015 [SpeedCalculator](DEBUG): Initializing SpeedCalculator.
2015-02-13T00:23:17.015Z,1423786997.015 [TempGradientCalculator](DEBUG): Initializing TempGradientCalculator.
2015-02-13T00:23:17.015Z,1423786997.015 [YawRateCalculator](DEBUG): Initializing YawRateCalculator.
2015-02-13T00:23:17.016Z,1423786997.016 [HFRCMReconstructedInterpolator](INFO): Initializing HFRCMReconstructedInterpolator component with velocityAccuracy_ = 0.300000 m/s.
2015-02-13T00:23:17.018Z,1423786997.018 [DeadReckonUsingMultipleVelocitySources](DEBUG): Initializing DeadReckonUsingMultipleVelocitySources component.
2015-02-13T00:23:17.019Z,1423786997.019 [DeadReckonUsingSpeedCalculator](DEBUG): Initializing DeadReckonUsingSpeedCalculator component.
2015-02-13T00:23:17.019Z,1423786997.019 [NavChart](DEBUG): Initialize NavChart Navigation.
2015-02-13T00:23:17.019Z,1423786997.019 [UniversalFixResidualReporter](DEBUG): Initializing UniversalFixResidualReporter component.
2015-02-13T00:23:17.025Z,1423786997.025 [ExternalSim](INFO): ExternalSim initializing...
2015-02-13T00:23:17.042Z,1423786997.042 [Radio_Surface](INFO): Powering up
2015-02-13T00:23:17.051Z,1423786997.051 [NavChartDb ThreadHandler](INFO): Handler Thread ID is 1145
2015-02-13T00:23:17.053Z,1423786997.053 [NavChartDb](INFO): Looking for Electronic Nav Chart files in directory: Resources
2015-02-13T00:23:17.055Z,1423786997.055 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US1WC07M.000
2015-02-13T00:23:17.055Z,1423786997.055 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US2WC11M.000
2015-02-13T00:23:17.055Z,1423786997.055 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US3CA52M.000
2015-02-13T00:23:17.055Z,1423786997.055 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4CA60M.000
2015-02-13T00:23:17.056Z,1423786997.056 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA50M.000
2015-02-13T00:23:17.056Z,1423786997.056 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA61M.000
2015-02-13T00:23:17.056Z,1423786997.056 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA62M.000
2015-02-13T00:23:17.056Z,1423786997.056 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA83M.000
2015-02-13T00:23:17.215Z,1423786997.215 [ExternalSim](DEBUG): beaconLat = 36.80340
2015-02-13T00:23:17.215Z,1423786997.215 [ExternalSim](DEBUG): beaconLon = -121.82230
2015-02-13T00:23:17.215Z,1423786997.215 [ExternalSim](DEBUG): beaconDepth = 25.00
2015-02-13T00:23:17.604Z,1423786997.604 [ExternalSim](DEBUG): Simulator initialized
2015-02-13T00:23:17.610Z,1423786997.610 [MissionManager](INFO): Loading Mission: Missions/Startup.xml
2015-02-13T00:23:17.623Z,1423786997.623 [Startup:A.GoToSurface](DEBUG): Construct GoToSurface.
2015-02-13T00:23:17.636Z,1423786997.636 [MissionManager](DEBUG): 
<?xml version="1.0" encoding="UTF-8"?>
<Mission xmlns="Tethys"
       xmlns:Control="Tethys/Control"
       xmlns:Guidance="Tethys/Guidance" 
       xmlns:Units="Tethys/Units"
       xmlns:Universal="Tethys/Universal"
       xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance"
       xsi:schemaLocation="Tethys http://aosn.mbari.org/tethys/Xml/Tethys.xsd
                           Tethys/Control http://aosn.mbari.org/tethys/Xml/Control.xsd
                           Tethys/Guidance http://aosn.mbari.org/tethys/Xml/Guidance.xsd
                           Tethys/Units http://aosn.mbari.org/tethys/Xml/Units.xsd
                           Tethys/Universal http://aosn.mbari.org/tethys/Xml/Universal.xsd"
       Id="Startup">

    <Guidance:GoToSurface>
        <Progression/>
    </Guidance:GoToSurface>

    <Aggregate Id="StartupSatComms">

        <Sequence/>

        <ReadDatum>
            <Timeout Duration="P1M" />
            <Universal:latitude_fix/>
        </ReadDatum>

        <ReadDatum>
            <Timeout Duration="P1M" />
            <Universal:platform_communications/>
        </ReadDatum>

    </Aggregate>

</Mission>


2015-02-13T00:23:17.637Z,1423786997.637 [MissionManager](INFO): Loading Mission: Missions/Default.xml
2015-02-13T00:23:17.700Z,1423786997.700 [MissionManager](INFO): DefineArg Default.TimeMissionWasStarted = 0.000000 h
2015-02-13T00:23:17.703Z,1423786997.703 [MissionManager](INFO): DefineArg Default.ElapsedSinceMissionWasStarted = 0.000000 h
2015-02-13T00:23:17.709Z,1423786997.709 [Default:B.GoToSurface](DEBUG): Construct GoToSurface.
2015-02-13T00:23:17.717Z,1423786997.717 [Default:CheckIn:A.SetSpeed](DEBUG): Construct.
2015-02-13T00:23:17.760Z,1423786997.760 [Default:CheckIn:Read_Iridium:A_Timeout:A.Execute](DEBUG): Construct Execute.
2015-02-13T00:23:17.780Z,1423786997.780 [Default:WaitAtTheSurface:RunApplicationAtLowSpeed.SetSpeed](DEBUG): Construct.
2015-02-13T00:23:17.786Z,1423786997.786 [MissionManager](DEBUG): 
<?xml version="1.0" encoding="UTF-8"?>
<Mission xmlns="Tethys"
xmlns:Control="Tethys/Control"
xmlns:Guidance="Tethys/Guidance" 
xmlns:Units="Tethys/Units"
xmlns:Universal="Tethys/Universal"
xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance"
xsi:schemaLocation="Tethys http://aosn.mbari.org/tethys/Xml/Tethys.xsd
Tethys/Control http://aosn.mbari.org/tethys/Xml/Control.xsd
Tethys/Guidance http://aosn.mbari.org/tethys/Xml/Guidance.xsd
Tethys/Units http://aosn.mbari.org/tethys/Xml/Units.xsd
Tethys/Universal http://aosn.mbari.org/tethys/Xml/Universal.xsd"
Id="Default">

    <DefineArg Name="TimeMissionWasStarted"><Units:hour/><Value>0</Value></DefineArg>

    <DefineArg Name="ElapsedSinceMissionWasStarted"><Units:hour/><Value>0</Value></DefineArg>

    <Aggregate Id="StartClock">

        <Sequence/>

        <Assign><Arg Name="TimeMissionWasStarted"/><Universal:time/></Assign>

    </Aggregate>

    <Guidance:GoToSurface>
        <Progression/>
    </Guidance:GoToSurface>

    <Aggregate Id="CheckIn">

        <When>
            <Elapsed><Universal:platform_communications/></Elapsed>
            <Gt><Units:minute/><Value>5.0</Value></Gt>
            <And><Universal:platform_conversation/><Eq><True/></Eq></And>
            <Or><Elapsed><Universal:platform_communications/></Elapsed><Gt><Units:hour/><Value>1.0</Value></Gt></Or>
        </When>

<!-- TODO: Do we really want this When operating on platform_communications? or on something else like time_fix? -->

<!-- Run application at high speed -->

        <Guidance:SetSpeed>
            <Parallel/>
            <Setting><Guidance:SetSpeed.period/><Units:millisecond/><Value>400</Value></Setting>
        </Guidance:SetSpeed>

        <ReadDatum Id="Read_GPS">
            <Timeout Duration="P5M"/>
<!-- NOTE: Original Default.xml didn't have a timeout on the GPS read, so theoretically could have hung indefinitely there... -->
            <Universal:latitude_fix/>
        </ReadDatum>

<!-- Do data comms -->

        <ReadDatum Id="Read_Iridium">
            <Timeout Duration="P2H">
                <Guidance:Execute>
                    <Sequence/>
                    <Setting><Guidance:Execute.command/><String>Burn 300</String></Setting>
                </Guidance:Execute>
                <Syslog Severity="Critical">Dropped drop weight due to communications timeout</Syslog>
            </Timeout>
            <Universal:platform_communications/>
        </ReadDatum>

    </Aggregate>

    <Aggregate Id="UpdateAndReportMinutesSinceMissionStarted">

        <When>
            <Elapsed><Arg Name="ElapsedSinceMissionWasStarted"/></Elapsed>
            <Gt><Units:minute/><Value>5.0</Value></Gt>
        </When>

        <Assign><Arg Name="ElapsedSinceMissionWasStarted"/><Universal:time/><Sub><Arg Name="TimeMissionWasStarted"/></Sub></Assign>

        <Syslog Severity="Important">Default mission has been running for <Arg Name="ElapsedSinceMissionWasStarted"/><Units:minute/></Syslog>

    </Aggregate>

    <Aggregate Id="WaitAtTheSurface">

        <Sequence/>

        <Guidance:SetSpeed Id="RunApplicationAtLowSpeed">
            <Parallel/>
            <Setting><Guidance:SetSpeed.period/><Units:second/><Value>5</Value></Setting>
        </Guidance:SetSpeed>

    </Aggregate>

</Mission>


2015-02-13T00:23:17.791Z,1423786997.791 [controlThread](DEBUG): Component order: CycleStarter,ExternalSim,DataOverHttps,Depth_Keller,NAL9602,Onboard,PNI_TCM,BPC1,Depth_Keller,DepthRateCalculator,PitchRateCalculator,SpeedCalculator,TempGradientCalculator,YawRateCalculator,HFRCMReconstructedInterpolator,DeadReckonUsingMultipleVelocitySources,DeadReckonUsingSpeedCalculator,NavChart,UniversalFixResidualReporter,MissionManager,VerticalControl,HorizontalControl,SpeedControl,LoopControl,BuoyancyServo,ElevatorServo,MassServo,RudderServo,ThrusterServo,SBIT,IBIT,CBIT,Reporter,LogSplitter,
2015-02-13T00:23:18.192Z,1423786998.192 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:18.199Z,1423786998.199 [DeadReckonUsingMultipleVelocitySources](DEBUG): No bottom track data -- 0 cycles since last successful read, accepting data for 5 cycles.
2015-02-13T00:23:18.296Z,1423786998.296 [BuoyancyServo](DEBUG): Initializing EZServoServo.
2015-02-13T00:23:18.297Z,1423786998.297 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
2015-02-13T00:23:18.315Z,1423786998.315 [ElevatorServo](DEBUG): Initializing EZServoServo.
2015-02-13T00:23:18.332Z,1423786998.332 [ElevatorServo](DEBUG): Initializing ElevatorServo.
2015-02-13T00:23:18.338Z,1423786998.338 [MassServo](DEBUG): Initializing EZServoServo.
2015-02-13T00:23:18.344Z,1423786998.344 [MassServo](DEBUG): Initializing MassServo.
2015-02-13T00:23:18.350Z,1423786998.350 [RudderServo](DEBUG): Initializing EZServoServo.
2015-02-13T00:23:18.356Z,1423786998.356 [RudderServo](DEBUG): Initializing RudderServo.
2015-02-13T00:23:18.362Z,1423786998.362 [ThrusterServo](DEBUG): Initializing EZServoServo.
2015-02-13T00:23:18.368Z,1423786998.368 [ThrusterServo](DEBUG): Initializing ThrusterServo.
2015-02-13T00:23:18.584Z,1423786998.584 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:18.589Z,1423786998.589 [DeadReckonUsingMultipleVelocitySources](DEBUG): No bottom track data -- 1 cycles since last successful read, accepting data for 5 cycles.
2015-02-13T00:23:24.854Z,1423787004.854 [NAL9602](INFO): Powering up NAL9602
2015-02-13T00:23:24.897Z,1423787004.897 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:24.898Z,1423787004.898 [DeadReckonUsingMultipleVelocitySources](DEBUG): No bottom track data -- 2 cycles since last successful read, accepting data for 5 cycles.
2015-02-13T00:23:25.360Z,1423787005.360 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:25.362Z,1423787005.362 [DeadReckonUsingMultipleVelocitySources](DEBUG): No bottom track data -- 3 cycles since last successful read, accepting data for 5 cycles.
2015-02-13T00:23:25.764Z,1423787005.764 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:25.765Z,1423787005.765 [DeadReckonUsingMultipleVelocitySources](DEBUG): No bottom track data -- 4 cycles since last successful read, accepting data for 5 cycles.
2015-02-13T00:23:26.085Z,1423787006.085 [DataOverHttps](INFO): setting available, lastComms_.elapsed()=0.003806
2015-02-13T00:23:26.132Z,1423787006.132 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:26.141Z,1423787006.141 [DeadReckonUsingMultipleVelocitySources](DEBUG): No bottom track data -- 5 cycles since last successful read, accepting data for 5 cycles.
2015-02-13T00:23:26.570Z,1423787006.570 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:26.909Z,1423787006.909 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:27.334Z,1423787007.334 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:28.025Z,1423787008.025 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:28.628Z,1423787008.628 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:29.053Z,1423787009.053 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:29.527Z,1423787009.527 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:29.907Z,1423787009.907 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:30.226Z,1423787010.226 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:30.738Z,1423787010.738 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:31.027Z,1423787011.027 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:31.480Z,1423787011.480 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:31.828Z,1423787011.828 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:32.226Z,1423787012.226 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:32.914Z,1423787012.914 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:32.940Z,1423787012.940 [SBIT](IMPORTANT): Beginning Startup BIT
2015-02-13T00:23:32.943Z,1423787012.943 [CBIT](IMPORTANT): Beginning GF scan
2015-02-13T00:23:33.146Z,1423787013.146 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:33.524Z,1423787013.524 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:34.112Z,1423787014.112 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:34.422Z,1423787014.422 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:35.077Z,1423787015.077 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:35.503Z,1423787015.503 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:35.821Z,1423787015.821 [NAL9602](INFO): NAL9602 initialized
2015-02-13T00:23:35.895Z,1423787015.895 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:36.333Z,1423787016.333 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:36.752Z,1423787016.752 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:37.157Z,1423787017.157 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:37.601Z,1423787017.601 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:38.114Z,1423787018.114 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:38.466Z,1423787018.466 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:38.847Z,1423787018.847 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:39.224Z,1423787019.224 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:39.634Z,1423787019.634 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:40.019Z,1423787020.019 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:40.398Z,1423787020.398 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:40.846Z,1423787020.846 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:41.203Z,1423787021.203 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:41.612Z,1423787021.612 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:42.042Z,1423787022.042 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:42.415Z,1423787022.415 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:42.774Z,1423787022.774 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:43.307Z,1423787023.307 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:43.652Z,1423787023.652 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:44.088Z,1423787024.088 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:44.473Z,1423787024.473 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:44.879Z,1423787024.879 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:45.263Z,1423787025.263 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:45.650Z,1423787025.650 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:46.075Z,1423787026.075 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:46.206Z,1423787026.206 [SBIT](FAULT): Mass: EXPECTED:0.006000 ACTUAL:0.005871
2015-02-13T00:23:46.464Z,1423787026.464 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:46.858Z,1423787026.858 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:47.312Z,1423787027.312 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:47.638Z,1423787027.638 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:48.374Z,1423787028.374 [NAL9602](INFO): SBD MO Status=0, MOMSN=5472, MT Status=0, MTMSN=0
2015-02-13T00:23:48.374Z,1423787028.374 [NAL9602](INFO): No messages in MT queue
2015-02-13T00:23:48.497Z,1423787028.497 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:49.046Z,1423787029.046 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:49.399Z,1423787029.399 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:49.801Z,1423787029.801 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:50.157Z,1423787030.157 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:50.546Z,1423787030.546 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:50.948Z,1423787030.948 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:51.419Z,1423787031.419 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:51.800Z,1423787031.800 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:52.155Z,1423787032.155 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:52.613Z,1423787032.613 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:53.005Z,1423787033.005 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:53.530Z,1423787033.530 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:53.948Z,1423787033.948 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:54.308Z,1423787034.308 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:54.675Z,1423787034.675 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:55.123Z,1423787035.123 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:55.524Z,1423787035.524 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:55.902Z,1423787035.902 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:56.299Z,1423787036.299 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:56.691Z,1423787036.691 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:56.914Z,1423787036.914 [CommandLine](IMPORTANT): got command report mod NAL9602.sigQuality
2015-02-13T00:23:57.093Z,1423787037.093 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:57.214Z,1423787037.214 [Reporter](INFO): NAL9602.sigQuality 5 count
2015-02-13T00:23:57.515Z,1423787037.515 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:57.889Z,1423787037.889 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:58.523Z,1423787038.523 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:58.839Z,1423787038.839 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:59.282Z,1423787039.282 [NAL9602](IMPORTANT): GPS fix at: -0.83
2015-02-13T00:23:59.339Z,1423787039.339 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:59.432Z,1423787039.432 [CBIT](IMPORTANT): No ground fault detected
2015-02-13T00:23:59.624Z,1423787039.624 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:23:59.984Z,1423787039.984 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:00.384Z,1423787040.384 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:00.813Z,1423787040.813 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:01.206Z,1423787041.206 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:01.586Z,1423787041.586 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:02.002Z,1423787042.002 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:02.407Z,1423787042.407 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:02.807Z,1423787042.807 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:03.204Z,1423787043.204 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:03.605Z,1423787043.605 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:04.031Z,1423787044.031 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:04.482Z,1423787044.482 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:04.837Z,1423787044.837 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:05.216Z,1423787045.216 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:05.686Z,1423787045.686 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:06.034Z,1423787046.034 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:06.392Z,1423787046.392 [NAL9602](INFO): Powering down
2015-02-13T00:24:06.488Z,1423787046.488 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:06.564Z,1423787046.564 [Reporter](INFO): NAL9602.sigQuality 0 count
2015-02-13T00:24:06.847Z,1423787046.847 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:07.240Z,1423787047.240 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:07.628Z,1423787047.628 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:08.042Z,1423787048.042 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:08.454Z,1423787048.454 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:08.838Z,1423787048.838 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:09.339Z,1423787049.339 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:09.620Z,1423787049.620 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:10.053Z,1423787050.053 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:10.537Z,1423787050.537 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:10.801Z,1423787050.801 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:11.234Z,1423787051.234 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:11.678Z,1423787051.678 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:12.019Z,1423787052.019 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:12.404Z,1423787052.404 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:12.876Z,1423787052.876 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:13.247Z,1423787053.247 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:14.018Z,1423787054.018 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:14.243Z,1423787054.243 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:14.712Z,1423787054.712 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:15.033Z,1423787055.033 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:15.471Z,1423787055.471 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:16.645Z,1423787056.645 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:16.903Z,1423787056.903 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:17.323Z,1423787057.323 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:17.848Z,1423787057.848 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:18.132Z,1423787058.132 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:18.584Z,1423787058.584 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:26.098Z,1423787066.098 [BPC1](ERROR): Failed to receive battery data
2015-02-13T00:24:26.098Z,1423787066.098 [BPC1] Communications Fault, FailCount= 1
2015-02-13T00:24:26.098Z,1423787066.098 [BPC1](ERROR): Communications Fault
2015-02-13T00:24:26.117Z,1423787066.117 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:26.230Z,1423787066.230 [CBIT](ERROR): Communications Fault in component: BPC1
2015-02-13T00:24:26.443Z,1423787066.443 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:26.798Z,1423787066.798 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:26.842Z,1423787066.842 [SBIT](CRITICAL): SBIT FAILED
2015-02-13T00:24:26.851Z,1423787066.851 [CommandLine](FAULT): Scheduling is paused
2015-02-13T00:24:27.227Z,1423787067.227 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:27.320Z,1423787067.320 [MissionManager](IMPORTANT): Started mission Startup
2015-02-13T00:24:27.320Z,1423787067.320 [Startup] Running Loop=1
2015-02-13T00:24:27.321Z,1423787067.321 [Startup](INFO): Aggregate::initialize Startup
2015-02-13T00:24:27.321Z,1423787067.321 [Startup:A.GoToSurface] Running Loop=1
2015-02-13T00:24:27.321Z,1423787067.321 [Startup:A.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2015-02-13T00:24:27.321Z,1423787067.321 [Startup:A.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2015-02-13T00:24:27.322Z,1423787067.322 [Startup:A.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2015-02-13T00:24:27.322Z,1423787067.322 [Startup:A.GoToSurface](DEBUG): No speed setting specified. Using default value of 0.500000 m/s.
2015-02-13T00:24:27.373Z,1423787067.373 [Startup:StartupSatComms] Running Loop=1
2015-02-13T00:24:27.373Z,1423787067.373 [Startup:StartupSatComms](INFO): Aggregate::initialize Startup:StartupSatComms
2015-02-13T00:24:27.374Z,1423787067.374 [Startup:StartupSatComms:A] Running Loop=1
2015-02-13T00:24:27.393Z,1423787067.393 [CBIT](INFO): Clearing failed state for component BPC1
2015-02-13T00:24:27.393Z,1423787067.393 [BPC1] No Fault, FailCount= 1
2015-02-13T00:24:27.723Z,1423787067.723 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:27.741Z,1423787067.741 [Startup:StartupSatComms:A](DEBUG): Initialize ReadDataComponent to sense latitude_fix
2015-02-13T00:24:27.917Z,1423787067.917 [NAL9602](INFO): Powering up
2015-02-13T00:24:27.971Z,1423787067.971 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:28.018Z,1423787068.018 [Reporter](INFO): NAL9602.sigQuality no_value
2015-02-13T00:24:28.410Z,1423787068.410 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:28.822Z,1423787068.822 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:29.395Z,1423787069.395 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:29.875Z,1423787069.875 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:30.199Z,1423787070.199 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:30.590Z,1423787070.590 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:30.929Z,1423787070.929 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:31.335Z,1423787071.335 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:31.766Z,1423787071.766 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:32.162Z,1423787072.162 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:32.569Z,1423787072.569 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:32.974Z,1423787072.974 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:33.329Z,1423787073.329 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:33.731Z,1423787073.731 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:34.429Z,1423787074.429 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:34.581Z,1423787074.581 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:34.981Z,1423787074.981 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:35.392Z,1423787075.392 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:35.778Z,1423787075.778 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:36.273Z,1423787076.273 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:36.552Z,1423787076.552 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:36.952Z,1423787076.952 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:37.397Z,1423787077.397 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:37.799Z,1423787077.799 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:38.195Z,1423787078.195 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:38.210Z,1423787078.210 [Reporter](INFO): NAL9602.sigQuality 0 count
2015-02-13T00:24:38.596Z,1423787078.596 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:38.942Z,1423787078.942 [NAL9602](INFO): NAL9602 initialized
2015-02-13T00:24:38.960Z,1423787078.960 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:39.465Z,1423787079.465 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:39.800Z,1423787079.800 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:40.219Z,1423787080.219 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:40.581Z,1423787080.581 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:40.975Z,1423787080.975 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:41.371Z,1423787081.371 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:41.774Z,1423787081.774 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:42.166Z,1423787082.166 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:42.588Z,1423787082.588 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:42.967Z,1423787082.967 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:43.388Z,1423787083.388 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:43.787Z,1423787083.787 [BPC1](ERROR): Failed to receive battery data
2015-02-13T00:24:43.787Z,1423787083.787 [BPC1] Communications Fault, FailCount= 2
2015-02-13T00:24:43.787Z,1423787083.787 [BPC1](ERROR): Communications Fault
2015-02-13T00:24:43.793Z,1423787083.793 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:43.884Z,1423787083.884 [CBIT](ERROR): Communications Fault in component: BPC1
2015-02-13T00:24:44.259Z,1423787084.259 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:44.618Z,1423787084.618 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:44.990Z,1423787084.990 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:45.032Z,1423787085.032 [CBIT](INFO): Clearing failed state for component BPC1
2015-02-13T00:24:45.032Z,1423787085.032 [BPC1] No Fault, FailCount= 2
2015-02-13T00:24:45.479Z,1423787085.479 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:45.818Z,1423787085.818 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:46.244Z,1423787086.244 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:46.667Z,1423787086.667 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:47.241Z,1423787087.241 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:47.443Z,1423787087.443 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:47.798Z,1423787087.798 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:48.195Z,1423787088.195 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:48.599Z,1423787088.599 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:48.966Z,1423787088.966 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:49.406Z,1423787089.406 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:49.430Z,1423787089.430 [Reporter](INFO): NAL9602.sigQuality 5 count
2015-02-13T00:24:49.809Z,1423787089.809 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:50.208Z,1423787090.208 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:50.566Z,1423787090.566 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:50.971Z,1423787090.971 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:51.393Z,1423787091.393 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:51.788Z,1423787091.788 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:52.193Z,1423787092.193 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:52.589Z,1423787092.589 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:52.983Z,1423787092.983 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:53.395Z,1423787093.395 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:53.798Z,1423787093.798 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:54.213Z,1423787094.213 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:54.906Z,1423787094.906 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:55.050Z,1423787095.050 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:55.470Z,1423787095.470 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:55.846Z,1423787095.846 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:56.240Z,1423787096.240 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:56.627Z,1423787096.627 [NAL9602](INFO): SBD MO Status=0, MOMSN=5473, MT Status=0, MTMSN=0
2015-02-13T00:24:56.628Z,1423787096.628 [NAL9602](INFO): No messages in MT queue
2015-02-13T00:24:56.672Z,1423787096.672 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:57.053Z,1423787097.053 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:57.490Z,1423787097.490 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:58.074Z,1423787098.074 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:58.287Z,1423787098.287 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:58.638Z,1423787098.638 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:59.086Z,1423787099.086 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:59.478Z,1423787099.478 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:24:59.911Z,1423787099.911 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:00.276Z,1423787100.276 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:00.662Z,1423787100.662 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:01.075Z,1423787101.075 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:01.447Z,1423787101.447 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:01.849Z,1423787101.849 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:02.252Z,1423787102.252 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:02.729Z,1423787102.729 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:03.067Z,1423787103.067 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:03.513Z,1423787103.513 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:03.927Z,1423787103.927 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:04.288Z,1423787104.288 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:04.648Z,1423787104.648 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:05.083Z,1423787105.083 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:05.482Z,1423787105.482 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:05.854Z,1423787105.854 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:06.263Z,1423787106.263 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:06.663Z,1423787106.663 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:07.045Z,1423787107.045 [NAL9602](IMPORTANT): GPS fix at: -0.96
2015-02-13T00:25:07.063Z,1423787107.063 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:07.069Z,1423787107.069 [Startup:StartupSatComms:A] Stopped
2015-02-13T00:25:07.069Z,1423787107.069 [Startup:StartupSatComms:B] Running Loop=1
2015-02-13T00:25:07.477Z,1423787107.477 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:07.527Z,1423787107.527 [Startup:StartupSatComms:B](DEBUG): Initialize ReadDataComponent to sense platform_communications
2015-02-13T00:25:08.216Z,1423787108.216 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:08.383Z,1423787108.383 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:13.867Z,1423787113.867 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:14.153Z,1423787114.153 [DataOverHttps](INFO): Sending 44 bytes from file Logs/20150130T010825/Courier0012.lzma
2015-02-13T00:25:14.223Z,1423787114.223 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:14.532Z,1423787114.532 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:14.852Z,1423787114.852 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:15.407Z,1423787115.407 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:15.636Z,1423787115.636 [DataOverHttps](INFO): Moved sent file to Logs/20150130T010825/Courier0012.lzma.bak
2015-02-13T00:25:15.636Z,1423787115.636 [DataOverHttps](INFO): SBD MOMSN=1528419
2015-02-13T00:25:15.698Z,1423787115.698 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:16.684Z,1423787116.684 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:16.901Z,1423787116.901 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:20.238Z,1423787120.238 [NAL9602](INFO): Powering down
2015-02-13T00:25:20.258Z,1423787120.258 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:20.298Z,1423787120.298 [Reporter](INFO): NAL9602.sigQuality 0 count
2015-02-13T00:25:20.461Z,1423787120.461 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:20.812Z,1423787120.812 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:21.242Z,1423787121.242 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:21.633Z,1423787121.633 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:22.036Z,1423787122.036 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:26.226Z,1423787126.226 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:26.399Z,1423787126.399 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:26.793Z,1423787126.793 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:27.156Z,1423787127.156 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:27.594Z,1423787127.594 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:27.960Z,1423787127.960 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:32.305Z,1423787132.305 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:32.413Z,1423787132.413 [DataOverHttps](INFO): Sending 92 bytes from file Logs/20150211T165805/Courier0000.lzma
2015-02-13T00:25:32.469Z,1423787132.469 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:32.889Z,1423787132.889 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:33.208Z,1423787133.208 [DataOverHttps](INFO): Moved sent file to Logs/20150211T165805/Courier0000.lzma.bak
2015-02-13T00:25:33.208Z,1423787133.208 [DataOverHttps](INFO): SBD MOMSN=1528422
2015-02-13T00:25:33.286Z,1423787133.286 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:33.880Z,1423787133.880 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:34.034Z,1423787134.034 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:37.272Z,1423787137.272 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:37.396Z,1423787137.396 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:37.795Z,1423787137.795 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:38.201Z,1423787138.201 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:38.604Z,1423787138.604 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:39.019Z,1423787139.019 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:42.594Z,1423787142.594 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:42.731Z,1423787142.731 [DataOverHttps](INFO): Sending 75 bytes from file Logs/20150211T165805/Courier0004.lzma
2015-02-13T00:25:42.789Z,1423787142.789 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:43.199Z,1423787143.199 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:43.528Z,1423787143.528 [DataOverHttps](INFO): Moved sent file to Logs/20150211T165805/Courier0004.lzma.bak
2015-02-13T00:25:43.528Z,1423787143.528 [DataOverHttps](INFO): SBD MOMSN=1528426
2015-02-13T00:25:43.672Z,1423787143.672 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:44.574Z,1423787144.574 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:44.741Z,1423787144.741 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:49.251Z,1423787149.251 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:49.401Z,1423787149.401 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:49.835Z,1423787149.835 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:50.203Z,1423787150.203 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:50.625Z,1423787150.625 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:51.147Z,1423787151.147 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:54.574Z,1423787154.574 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:54.680Z,1423787154.680 [DataOverHttps](INFO): Sending 173 bytes from file Logs/20150211T165805/Courier0008.lzma
2015-02-13T00:25:54.732Z,1423787154.732 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:55.115Z,1423787155.115 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:55.474Z,1423787155.474 [DataOverHttps](INFO): Moved sent file to Logs/20150211T165805/Courier0008.lzma.bak
2015-02-13T00:25:55.474Z,1423787155.474 [DataOverHttps](INFO): SBD MOMSN=1528429
2015-02-13T00:25:55.496Z,1423787155.496 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:56.150Z,1423787156.150 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:56.337Z,1423787156.337 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:59.586Z,1423787159.586 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:25:59.765Z,1423787159.765 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:00.153Z,1423787160.153 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:00.559Z,1423787160.559 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:00.919Z,1423787160.919 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:01.425Z,1423787161.425 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:04.668Z,1423787164.668 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:04.795Z,1423787164.795 [DataOverHttps](INFO): Sending 72 bytes from file Logs/20150211T183306/Courier0000.lzma
2015-02-13T00:26:04.822Z,1423787164.822 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:05.226Z,1423787165.226 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:05.587Z,1423787165.587 [DataOverHttps](INFO): Moved sent file to Logs/20150211T183306/Courier0000.lzma.bak
2015-02-13T00:26:05.588Z,1423787165.588 [DataOverHttps](INFO): SBD MOMSN=1528445
2015-02-13T00:26:05.672Z,1423787165.672 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:06.266Z,1423787166.266 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:06.526Z,1423787166.526 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:09.682Z,1423787169.682 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:09.689Z,1423787169.689 [Startup:StartupSatComms:B](INFO): Timed out from 2015-02-13T00:25:07.1Z
2015-02-13T00:26:09.689Z,1423787169.689 [Startup:StartupSatComms:B] Stopped
2015-02-13T00:26:09.689Z,1423787169.689 [Startup:StartupSatComms](INFO): Completed Startup:StartupSatComms
2015-02-13T00:26:09.689Z,1423787169.689 [Startup:StartupSatComms] Stopped
2015-02-13T00:26:09.689Z,1423787169.689 [Startup:StartupSatComms](INFO): Aggregate::uninitialize Startup:StartupSatComms
2015-02-13T00:26:09.690Z,1423787169.690 [Startup](INFO): Completed Startup
2015-02-13T00:26:09.690Z,1423787169.690 [Startup] Stopped
2015-02-13T00:26:09.691Z,1423787169.691 [Startup](INFO): Aggregate::uninitialize Startup
2015-02-13T00:26:09.691Z,1423787169.691 [Startup:A.GoToSurface] Stopped
2015-02-13T00:26:09.691Z,1423787169.691 [Startup:A.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2015-02-13T00:26:09.898Z,1423787169.898 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:09.935Z,1423787169.935 [MissionManager](IMPORTANT): Started mission Default
2015-02-13T00:26:09.935Z,1423787169.935 [Default] Running Loop=1
2015-02-13T00:26:09.936Z,1423787169.936 [Default](INFO): Aggregate::initialize Default
2015-02-13T00:26:09.936Z,1423787169.936 [Default:B.GoToSurface] Running Loop=1
2015-02-13T00:26:09.936Z,1423787169.936 [Default:B.GoToSurface](DEBUG): Initialize GoToSurfaceComponent.
2015-02-13T00:26:09.936Z,1423787169.936 [Default:B.GoToSurface](DEBUG): No depth rate setting specified. Using default value of nan m/s.
2015-02-13T00:26:09.936Z,1423787169.936 [Default:B.GoToSurface](DEBUG): No pitch setting specified. Using default value of nan degrees.
2015-02-13T00:26:09.937Z,1423787169.937 [Default:B.GoToSurface](DEBUG): No speed setting specified. Using default value of 0.500000 m/s.
2015-02-13T00:26:09.937Z,1423787169.937 [Default:StartClock] Running Loop=1
2015-02-13T00:26:09.937Z,1423787169.937 [Default:StartClock](INFO): Aggregate::initialize Default:StartClock
2015-02-13T00:26:09.937Z,1423787169.937 [Default:StartClock:A] Running Loop=1
2015-02-13T00:26:09.938Z,1423787169.938 [Default:CheckIn] Running Loop=1
2015-02-13T00:26:09.938Z,1423787169.938 [Default:CheckIn](INFO): Aggregate::initialize Default:CheckIn
2015-02-13T00:26:09.938Z,1423787169.938 [Default:CheckIn:A.SetSpeed] Running Loop=1
2015-02-13T00:26:09.938Z,1423787169.938 [Default:CheckIn:A.SetSpeed](DEBUG): Initialize.
2015-02-13T00:26:09.938Z,1423787169.938 [Default:CheckIn:Read_GPS] Running Loop=1
2015-02-13T00:26:09.948Z,1423787169.948 [Default:CheckIn:Read_GPS](DEBUG): Initialize ReadDataComponent to sense latitude_fix
2015-02-13T00:26:09.950Z,1423787169.950 [Default:CheckIn:A.SetSpeed] Running Loop=1
2015-02-13T00:26:09.982Z,1423787169.982 [Default:StartClock:A] Stopped
2015-02-13T00:26:09.982Z,1423787169.982 [Default:StartClock](INFO): Completed Default:StartClock
2015-02-13T00:26:09.982Z,1423787169.982 [Default:StartClock] Stopped
2015-02-13T00:26:09.982Z,1423787169.982 [Default:StartClock](INFO): Aggregate::uninitialize Default:StartClock
2015-02-13T00:26:10.244Z,1423787170.244 [NAL9602](INFO): Powering up
2015-02-13T00:26:10.327Z,1423787170.327 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:10.334Z,1423787170.334 [Default:WaitAtTheSurface] Running Loop=1
2015-02-13T00:26:10.334Z,1423787170.334 [Default:WaitAtTheSurface](INFO): Aggregate::initialize Default:WaitAtTheSurface
2015-02-13T00:26:10.334Z,1423787170.334 [Default:WaitAtTheSurface:RunApplicationAtLowSpeed.SetSpeed] Running Loop=1
2015-02-13T00:26:10.335Z,1423787170.335 [Default:WaitAtTheSurface:RunApplicationAtLowSpeed.SetSpeed](DEBUG): Initialize.
2015-02-13T00:26:10.356Z,1423787170.356 [Reporter](INFO): NAL9602.sigQuality no_value
2015-02-13T00:26:10.674Z,1423787170.674 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:10.680Z,1423787170.680 [Default:WaitAtTheSurface:RunApplicationAtLowSpeed.SetSpeed] Running Loop=1
2015-02-13T00:26:11.075Z,1423787171.075 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:11.624Z,1423787171.624 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:14.667Z,1423787174.667 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:14.806Z,1423787174.806 [DataOverHttps](INFO): Sending 98 bytes from file Logs/20150211T183306/Courier0004.lzma
2015-02-13T00:26:14.827Z,1423787174.827 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:15.234Z,1423787175.234 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:15.884Z,1423787175.884 [DataOverHttps](INFO): Moved sent file to Logs/20150211T183306/Courier0004.lzma.bak
2015-02-13T00:26:15.884Z,1423787175.884 [DataOverHttps](INFO): SBD MOMSN=1528449
2015-02-13T00:26:15.958Z,1423787175.958 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:16.182Z,1423787176.182 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:16.797Z,1423787176.797 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:16.965Z,1423787176.965 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:17.361Z,1423787177.361 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:17.762Z,1423787177.762 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:18.159Z,1423787178.159 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:18.567Z,1423787178.567 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:18.966Z,1423787178.966 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:19.369Z,1423787179.369 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:19.808Z,1423787179.808 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:20.200Z,1423787180.200 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:20.567Z,1423787180.567 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:20.608Z,1423787180.608 [Reporter](INFO): NAL9602.sigQuality 0 count
2015-02-13T00:26:20.990Z,1423787180.990 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:21.334Z,1423787181.334 [NAL9602](INFO): NAL9602 initialized
2015-02-13T00:26:21.452Z,1423787181.452 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:21.900Z,1423787181.900 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:22.177Z,1423787182.178 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:22.598Z,1423787182.598 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:22.958Z,1423787182.958 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:23.387Z,1423787183.387 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:23.802Z,1423787183.802 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:24.178Z,1423787184.178 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:24.590Z,1423787184.590 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:24.951Z,1423787184.951 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:25.359Z,1423787185.359 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:25.759Z,1423787185.759 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:26.167Z,1423787186.167 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:26.574Z,1423787186.574 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:26.965Z,1423787186.965 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:27.369Z,1423787187.369 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:27.770Z,1423787187.770 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:28.210Z,1423787188.210 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:28.567Z,1423787188.567 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:28.968Z,1423787188.968 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:29.364Z,1423787189.364 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:29.756Z,1423787189.756 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:30.187Z,1423787190.187 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:30.546Z,1423787190.546 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:30.946Z,1423787190.946 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:31.355Z,1423787191.355 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:31.381Z,1423787191.381 [Reporter](INFO): NAL9602.sigQuality 5 count
2015-02-13T00:26:31.748Z,1423787191.748 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:32.201Z,1423787192.201 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:32.594Z,1423787192.594 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:33.028Z,1423787193.028 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:33.350Z,1423787193.350 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:33.772Z,1423787193.772 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:34.260Z,1423787194.260 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:34.569Z,1423787194.569 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:34.945Z,1423787194.945 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:35.381Z,1423787195.381 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:35.817Z,1423787195.817 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:36.175Z,1423787196.175 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:36.696Z,1423787196.696 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:37.199Z,1423787197.199 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:37.389Z,1423787197.389 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:37.827Z,1423787197.827 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:38.137Z,1423787198.137 [NAL9602](INFO): SBD MO Status=0, MOMSN=5474, MT Status=0, MTMSN=0
2015-02-13T00:26:38.138Z,1423787198.138 [NAL9602](INFO): No messages in MT queue
2015-02-13T00:26:38.225Z,1423787198.225 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:38.550Z,1423787198.550 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:39.030Z,1423787199.030 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:39.328Z,1423787199.328 [NAL9602](IMPORTANT): GPS fix at: -0.68
2015-02-13T00:26:39.376Z,1423787199.376 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:39.384Z,1423787199.384 [Default:CheckIn:Read_GPS] Stopped
2015-02-13T00:26:39.384Z,1423787199.384 [Default:CheckIn:Read_Iridium] Running Loop=1
2015-02-13T00:26:39.769Z,1423787199.769 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:39.781Z,1423787199.781 [Default:CheckIn:Read_Iridium](DEBUG): Initialize ReadDataComponent to sense platform_communications
2015-02-13T00:26:40.398Z,1423787200.398 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:40.602Z,1423787200.602 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:45.233Z,1423787205.233 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:45.414Z,1423787205.414 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:46.024Z,1423787206.024 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:46.259Z,1423787206.259 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:46.716Z,1423787206.716 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:47.091Z,1423787207.091 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:50.335Z,1423787210.335 [NAL9602](INFO): Powering down
2015-02-13T00:26:50.427Z,1423787210.427 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:50.467Z,1423787210.467 [Reporter](INFO): NAL9602.sigQuality 0 count
2015-02-13T00:26:50.559Z,1423787210.559 [DataOverHttps](INFO): Sending 92 bytes from file Logs/20150211T183306/Courier0008.lzma
2015-02-13T00:26:50.620Z,1423787210.620 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:51.030Z,1423787211.030 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:51.355Z,1423787211.355 [DataOverHttps](INFO): Moved sent file to Logs/20150211T183306/Courier0008.lzma.bak
2015-02-13T00:26:51.356Z,1423787211.356 [DataOverHttps](INFO): SBD MOMSN=1528453
2015-02-13T00:26:51.420Z,1423787211.420 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:52.073Z,1423787212.073 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:52.194Z,1423787212.194 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:55.487Z,1423787215.487 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:55.671Z,1423787215.671 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:56.036Z,1423787216.036 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:56.437Z,1423787216.437 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:56.838Z,1423787216.838 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:26:57.241Z,1423787217.241 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:00.634Z,1423787220.634 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:00.744Z,1423787220.744 [DataOverHttps](INFO): Sending 98 bytes from file Logs/20150211T184420/Courier0004.lzma
2015-02-13T00:27:00.781Z,1423787220.781 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:01.159Z,1423787221.159 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:01.546Z,1423787221.546 [DataOverHttps](INFO): Moved sent file to Logs/20150211T184420/Courier0004.lzma.bak
2015-02-13T00:27:01.546Z,1423787221.546 [DataOverHttps](INFO): SBD MOMSN=1528457
2015-02-13T00:27:01.568Z,1423787221.568 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:02.368Z,1423787222.368 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:02.865Z,1423787222.865 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:05.860Z,1423787225.860 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:06.015Z,1423787226.015 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:06.422Z,1423787226.422 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:06.813Z,1423787226.813 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:07.174Z,1423787227.174 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:07.656Z,1423787227.656 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:08.024Z,1423787228.024 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:11.292Z,1423787231.292 [BPC1](ERROR): Failed to receive battery data
2015-02-13T00:27:11.292Z,1423787231.292 [BPC1] Communications Fault, FailCount= 1
2015-02-13T00:27:11.292Z,1423787231.292 [BPC1](ERROR): Communications Fault
2015-02-13T00:27:11.298Z,1423787231.298 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:11.351Z,1423787231.351 [CBIT](ERROR): Communications Fault in component: BPC1
2015-02-13T00:27:18.696Z,1423787238.696 [DataOverHttps](INFO): Sending 70 bytes from file Logs/20150211T184420/Courier0008.lzma
2015-02-13T00:27:18.743Z,1423787238.743 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:18.951Z,1423787238.951 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:20.499Z,1423787240.499 [DataOverHttps](INFO): Moved sent file to Logs/20150211T184420/Courier0008.lzma.bak
2015-02-13T00:27:20.499Z,1423787240.499 [DataOverHttps](INFO): SBD MOMSN=1528461
2015-02-13T00:27:20.550Z,1423787240.550 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:20.598Z,1423787240.598 [CBIT](INFO): Clearing failed state for component BPC1
2015-02-13T00:27:20.598Z,1423787240.598 [BPC1] No Fault, FailCount= 1
2015-02-13T00:27:21.043Z,1423787241.043 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:21.201Z,1423787241.201 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:24.501Z,1423787244.501 [CommandLine](IMPORTANT): got command get latitude
2015-02-13T00:27:24.502Z,1423787244.502 [CommandLine](IMPORTANT): latitude 36.803424 arcdeg
2015-02-13T00:27:24.867Z,1423787244.867 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:25.046Z,1423787245.046 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:25.418Z,1423787245.418 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:25.824Z,1423787245.824 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:26.235Z,1423787246.235 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:26.683Z,1423787246.683 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:26.845Z,1423787246.845 [CommandLine](IMPORTANT): got command get longitude
2015-02-13T00:27:26.845Z,1423787246.845 [CommandLine](IMPORTANT): longitude -121.822242 arcdeg
2015-02-13T00:27:29.996Z,1423787249.996 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:30.138Z,1423787250.138 [DataOverHttps](INFO): Sending 267 bytes from file Logs/20150213T002152/Courier0000.lzma
2015-02-13T00:27:30.202Z,1423787250.202 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:30.594Z,1423787250.594 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:30.940Z,1423787250.940 [DataOverHttps](INFO): Moved sent file to Logs/20150213T002152/Courier0000.lzma.bak
2015-02-13T00:27:30.940Z,1423787250.940 [DataOverHttps](INFO): SBD MOMSN=1528464
2015-02-13T00:27:31.008Z,1423787251.008 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:31.613Z,1423787251.613 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:31.801Z,1423787251.801 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:35.146Z,1423787255.146 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:35.304Z,1423787255.304 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:35.695Z,1423787255.695 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:36.076Z,1423787256.076 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:36.513Z,1423787256.513 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:36.938Z,1423787256.938 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:40.088Z,1423787260.088 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:40.265Z,1423787260.265 [DataOverHttps](INFO): Sending 244 bytes from file Logs/20150213T002306/Courier0000.lzma
2015-02-13T00:27:40.295Z,1423787260.295 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:40.716Z,1423787260.716 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:41.035Z,1423787261.035 [DataOverHttps](INFO): Moved sent file to Logs/20150213T002306/Courier0000.lzma.bak
2015-02-13T00:27:41.035Z,1423787261.035 [DataOverHttps](INFO): SBD MOMSN=1528471
2015-02-13T00:27:41.099Z,1423787261.099 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:41.758Z,1423787261.758 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:41.941Z,1423787261.941 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:47.342Z,1423787267.342 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:47.600Z,1423787267.600 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:48.064Z,1423787268.064 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:48.363Z,1423787268.363 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:48.968Z,1423787268.968 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:49.381Z,1423787269.381 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:53.009Z,1423787273.009 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:53.203Z,1423787273.203 [DataOverHttps](INFO): Sending 63 bytes from file Logs/20150213T002306/Courier0004.lzma
2015-02-13T00:27:53.229Z,1423787273.229 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:27:53.542Z,1423787273.542 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:06.450Z,1423787286.450 [DataOverHttps](INFO): Moved sent file to Logs/20150213T002306/Courier0004.lzma.bak
2015-02-13T00:28:06.450Z,1423787286.450 [DataOverHttps](INFO): SBD MOMSN=1528476
2015-02-13T00:28:06.499Z,1423787286.499 [BPC1](ERROR): Failed to receive battery data
2015-02-13T00:28:06.499Z,1423787286.499 [BPC1] Communications Fault, FailCount= 1
2015-02-13T00:28:06.499Z,1423787286.499 [BPC1](ERROR): Communications Fault
2015-02-13T00:28:06.504Z,1423787286.504 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:06.573Z,1423787286.573 [CBIT](ERROR): Communications Fault in component: BPC1
2015-02-13T00:28:07.309Z,1423787287.309 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:07.526Z,1423787287.526 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:11.024Z,1423787291.024 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:11.068Z,1423787291.068 [CBIT](INFO): Clearing failed state for component BPC1
2015-02-13T00:28:11.068Z,1423787291.068 [BPC1] No Fault, FailCount= 1
2015-02-13T00:28:11.557Z,1423787291.557 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:11.875Z,1423787291.875 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:12.414Z,1423787292.414 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:12.735Z,1423787292.735 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:13.193Z,1423787293.193 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:16.750Z,1423787296.750 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:16.924Z,1423787296.924 [DataOverHttps](INFO): Sending 322 bytes from file Logs/20150130T010825/Express0013.lzma
2015-02-13T00:28:16.983Z,1423787296.983 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:17.363Z,1423787297.363 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:17.802Z,1423787297.802 [DataOverHttps](INFO): Moved sent file to Logs/20150130T010825/Express0013.lzma.bak
2015-02-13T00:28:17.802Z,1423787297.802 [DataOverHttps](INFO): SBD MOMSN=1528479
2015-02-13T00:28:17.824Z,1423787297.824 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:17.847Z,1423787297.847 [Default:UpdateAndReportMinutesSinceMissionStarted] Running Loop=1
2015-02-13T00:28:17.847Z,1423787297.847 [Default:UpdateAndReportMinutesSinceMissionStarted](INFO): Aggregate::initialize Default:UpdateAndReportMinutesSinceMissionStarted
2015-02-13T00:28:17.847Z,1423787297.847 [Default:UpdateAndReportMinutesSinceMissionStarted:A] Running Loop=1
2015-02-13T00:28:17.849Z,1423787297.849 [Default:UpdateAndReportMinutesSinceMissionStarted:A] Stopped
2015-02-13T00:28:17.849Z,1423787297.849 [Default:UpdateAndReportMinutesSinceMissionStarted:B] Running Loop=1
2015-02-13T00:28:18.826Z,1423787298.826 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:18.834Z,1423787298.834 [Default:UpdateAndReportMinutesSinceMissionStarted:B](IMPORTANT): Default mission has been running for 2.130447 min 
2015-02-13T00:28:18.838Z,1423787298.838 [Default:UpdateAndReportMinutesSinceMissionStarted:B] Stopped
2015-02-13T00:28:18.839Z,1423787298.839 [Default:UpdateAndReportMinutesSinceMissionStarted](INFO): Completed Default:UpdateAndReportMinutesSinceMissionStarted
2015-02-13T00:28:18.839Z,1423787298.839 [Default:UpdateAndReportMinutesSinceMissionStarted] Stopped
2015-02-13T00:28:18.839Z,1423787298.839 [Default:UpdateAndReportMinutesSinceMissionStarted](INFO): Aggregate::uninitialize Default:UpdateAndReportMinutesSinceMissionStarted
2015-02-13T00:28:19.042Z,1423787299.042 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:22.994Z,1423787302.994 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:23.522Z,1423787303.522 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:23.781Z,1423787303.781 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:24.144Z,1423787304.144 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:24.857Z,1423787304.857 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:25.039Z,1423787305.039 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:28.480Z,1423787308.480 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:28.708Z,1423787308.708 [DataOverHttps](INFO): Sending 869 bytes from file Logs/20150211T165805/Express0001.lzma
2015-02-13T00:28:28.762Z,1423787308.762 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:29.080Z,1423787309.080 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:29.514Z,1423787309.514 [DataOverHttps](INFO): Moved sent file to Logs/20150211T165805/Express0001.lzma.bak
2015-02-13T00:28:29.514Z,1423787309.514 [DataOverHttps](INFO): SBD MOMSN=1528492
2015-02-13T00:28:29.609Z,1423787309.609 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:30.460Z,1423787310.460 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:30.765Z,1423787310.765 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:34.017Z,1423787314.017 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:34.224Z,1423787314.224 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:34.628Z,1423787314.628 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:35.246Z,1423787315.246 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:35.585Z,1423787315.585 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:36.032Z,1423787316.032 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:39.944Z,1423787319.944 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:40.256Z,1423787320.256 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:40.536Z,1423787320.536 [DataOverHttps](INFO): Sending 652 bytes from file Logs/20150211T165805/Express0005.lzma
2015-02-13T00:28:40.595Z,1423787320.595 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:41.005Z,1423787321.005 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:41.459Z,1423787321.459 [DataOverHttps](INFO): Moved sent file to Logs/20150211T165805/Express0005.lzma.bak
2015-02-13T00:28:41.460Z,1423787321.460 [DataOverHttps](INFO): SBD MOMSN=1528517
2015-02-13T00:28:41.610Z,1423787321.610 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:42.620Z,1423787322.620 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:44.400Z,1423787324.400 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:50.023Z,1423787330.023 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:50.790Z,1423787330.790 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:51.275Z,1423787331.275 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:51.495Z,1423787331.495 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:51.945Z,1423787331.945 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:52.525Z,1423787332.525 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:56.717Z,1423787336.717 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:57.239Z,1423787337.239 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:59.243Z,1423787339.243 [DataOverHttps](INFO): Sending 1541 bytes from file Logs/20150211T165805/Express0009.lzma
2015-02-13T00:28:59.274Z,1423787339.274 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:59.617Z,1423787339.617 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:28:59.942Z,1423787339.942 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:01.964Z,1423787341.964 [DataOverHttps](INFO): Moved sent file to Logs/20150211T165805/Express0009.lzma.bak
2015-02-13T00:29:01.965Z,1423787341.965 [DataOverHttps](INFO): SBD MOMSN=1528537
2015-02-13T00:29:02.037Z,1423787342.037 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:02.743Z,1423787342.743 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:03.064Z,1423787343.064 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:06.506Z,1423787346.506 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:06.778Z,1423787346.778 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:07.082Z,1423787347.082 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:07.538Z,1423787347.538 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:08.158Z,1423787348.158 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:08.483Z,1423787348.483 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:08.797Z,1423787348.797 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:12.218Z,1423787352.218 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:12.345Z,1423787352.345 [DataOverHttps](INFO): Sending 580 bytes from file Logs/20150211T180012/Express0001.lzma
2015-02-13T00:29:12.396Z,1423787352.396 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:13.018Z,1423787353.018 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:13.217Z,1423787353.217 [DataOverHttps](INFO): Moved sent file to Logs/20150211T180012/Express0001.lzma.bak
2015-02-13T00:29:13.218Z,1423787353.218 [DataOverHttps](INFO): SBD MOMSN=1528711
2015-02-13T00:29:13.251Z,1423787353.251 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:14.582Z,1423787354.582 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:14.821Z,1423787354.821 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:18.184Z,1423787358.184 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:18.505Z,1423787358.505 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:18.899Z,1423787358.899 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:19.291Z,1423787359.291 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:19.949Z,1423787359.949 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:20.263Z,1423787360.263 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:23.614Z,1423787363.614 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:23.872Z,1423787363.872 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:24.231Z,1423787364.231 [DataOverHttps](INFO): Sending 614 bytes from file Logs/20150211T183306/Express0001.lzma
2015-02-13T00:29:24.317Z,1423787364.317 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:24.637Z,1423787364.637 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:24.971Z,1423787364.971 [DataOverHttps](INFO): Moved sent file to Logs/20150211T183306/Express0001.lzma.bak
2015-02-13T00:29:24.971Z,1423787364.971 [DataOverHttps](INFO): SBD MOMSN=1528728
2015-02-13T00:29:25.027Z,1423787365.027 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:26.004Z,1423787366.004 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:26.353Z,1423787366.353 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:29.998Z,1423787369.998 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:30.199Z,1423787370.199 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:30.567Z,1423787370.567 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:31.142Z,1423787371.142 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:31.358Z,1423787371.358 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:31.760Z,1423787371.760 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:35.152Z,1423787375.152 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:35.275Z,1423787375.275 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:44.824Z,1423787384.824 [DataOverHttps](INFO): Sending 571 bytes from file Logs/20150211T183306/Express0005.lzma
2015-02-13T00:29:44.981Z,1423787384.981 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:45.185Z,1423787385.185 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:46.062Z,1423787386.062 [CommandLine](IMPORTANT): got command quit
2015-02-13T00:29:47.068Z,1423787387.068 [CommandLine ThreadHandler](INFO): Uninitializing protected caller thread.
2015-02-13T00:29:47.069Z,1423787387.069 [CommandLine ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.213Z,1423787387.213 [Supervisor](DEBUG): Uninitializing supervisor and starting cleanup.  Bye!
2015-02-13T00:29:47.213Z,1423787387.213 [CommandLine ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.214Z,1423787387.214 [CommandLine](INFO): Join timeout helper Thread ID is 1211
2015-02-13T00:29:47.214Z,1423787387.214 [ComponentRegistry](INFO): Shutting down NavChartDb ThreadHandler
2015-02-13T00:29:47.214Z,1423787387.214 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.215Z,1423787387.215 [NavChartDb](INFO): Join timeout helper Thread ID is 1212
2015-02-13T00:29:47.313Z,1423787387.313 [NavChartDb ThreadHandler](INFO): Uninitializing protected caller thread.
2015-02-13T00:29:47.313Z,1423787387.313 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.317Z,1423787387.317 [ComponentRegistry](INFO): Shutting down Radio_Surface ThreadHandler
2015-02-13T00:29:47.317Z,1423787387.317 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.318Z,1423787387.318 [Radio_Surface](INFO): Join timeout helper Thread ID is 1213
2015-02-13T00:29:47.452Z,1423787387.452 [DataOverHttps](INFO): Moved sent file to Logs/20150211T183306/Express0005.lzma.bak
2015-02-13T00:29:47.452Z,1423787387.452 [DataOverHttps](INFO): SBD MOMSN=1528744
2015-02-13T00:29:47.470Z,1423787387.470 [Radio_Surface ThreadHandler](INFO): Uninitializing protected caller thread.
2015-02-13T00:29:47.470Z,1423787387.470 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.477Z,1423787387.477 [ComponentRegistry](INFO): Shutting down logger ThreadHandler
2015-02-13T00:29:47.478Z,1423787387.478 [logger ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.478Z,1423787387.478 [logger](INFO): Join timeout helper Thread ID is 1214
2015-02-13T00:29:47.497Z,1423787387.497 [logger ThreadHandler](INFO): Uninitializing protected caller thread.
2015-02-13T00:29:47.498Z,1423787387.498 [logger ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.513Z,1423787387.513 [ComponentRegistry](INFO): Shutting down CommandLine ThreadHandler
2015-02-13T00:29:47.514Z,1423787387.514 [CommandLine ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.514Z,1423787387.514 [ComponentRegistry](INFO): Shutting down controlThread ThreadHandler
2015-02-13T00:29:47.514Z,1423787387.514 [controlThread ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.514Z,1423787387.514 [controlThread](INFO): Join timeout helper Thread ID is 1215
2015-02-13T00:29:47.526Z,1423787387.526 [HFRCMReconstructedInterpolator](DEBUG): no valid forecast
2015-02-13T00:29:47.543Z,1423787387.543 [controlThread ThreadHandler](INFO): Uninitializing protected caller thread.
2015-02-13T00:29:47.543Z,1423787387.543 [controlThread](DEBUG): Uninitializing ControlThread
2015-02-13T00:29:47.545Z,1423787387.545 [NAL9602](INFO): Powering down
2015-02-13T00:29:47.547Z,1423787387.547 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
2015-02-13T00:29:47.548Z,1423787387.548 [NavChart](DEBUG): Uninitialize NavChart Navigation.
2015-02-13T00:29:47.549Z,1423787387.549 [Default] Stopped
2015-02-13T00:29:47.549Z,1423787387.549 [Default](INFO): Aggregate::uninitialize Default
2015-02-13T00:29:47.549Z,1423787387.549 [Default:B.GoToSurface] Stopped
2015-02-13T00:29:47.549Z,1423787387.549 [Default:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2015-02-13T00:29:47.549Z,1423787387.549 [Default:CheckIn] Stopped
2015-02-13T00:29:47.549Z,1423787387.549 [Default:CheckIn](INFO): Aggregate::uninitialize Default:CheckIn
2015-02-13T00:29:47.550Z,1423787387.550 [Default:CheckIn:A.SetSpeed] Stopped
2015-02-13T00:29:47.550Z,1423787387.550 [Default:CheckIn:A.SetSpeed](DEBUG): Uninitialize.
2015-02-13T00:29:47.550Z,1423787387.550 [Default:CheckIn:Read_Iridium] Stopped
2015-02-13T00:29:47.550Z,1423787387.550 [Default:WaitAtTheSurface] Stopped
2015-02-13T00:29:47.550Z,1423787387.550 [Default:WaitAtTheSurface](INFO): Aggregate::uninitialize Default:WaitAtTheSurface
2015-02-13T00:29:47.550Z,1423787387.550 [Default:WaitAtTheSurface:RunApplicationAtLowSpeed.SetSpeed] Stopped
2015-02-13T00:29:47.550Z,1423787387.550 [Default:WaitAtTheSurface:RunApplicationAtLowSpeed.SetSpeed](DEBUG): Uninitialize.
2015-02-13T00:29:47.554Z,1423787387.554 [VerticalControl](DEBUG): Uninitialize VerticalControlComponent.
2015-02-13T00:29:47.554Z,1423787387.554 [HorizontalControl](DEBUG): Uninitialize HorizontalControlComponent.
2015-02-13T00:29:47.554Z,1423787387.554 [SpeedControl](DEBUG): Uninitialize SpeedControlComponent.
2015-02-13T00:29:47.555Z,1423787387.555 [LoopControl](DEBUG): Uninitialize LoopControlComponent.
2015-02-13T00:29:47.555Z,1423787387.555 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2015-02-13T00:29:47.555Z,1423787387.555 [BuoyancyServo](INFO): Powering down
2015-02-13T00:29:47.570Z,1423787387.570 [ElevatorServo](DEBUG): Uninitialize Elevator Servo.
2015-02-13T00:29:47.570Z,1423787387.570 [ElevatorServo](INFO): Powering down
2015-02-13T00:29:47.571Z,1423787387.571 [MassServo](DEBUG): Uninitialize Mass Servo.
2015-02-13T00:29:47.571Z,1423787387.571 [MassServo](INFO): Powering down
2015-02-13T00:29:47.571Z,1423787387.571 [RudderServo](DEBUG): Uninitialize Rudder Servo.
2015-02-13T00:29:47.572Z,1423787387.572 [RudderServo](INFO): Powering down
2015-02-13T00:29:47.572Z,1423787387.572 [ThrusterServo](DEBUG): Uninitialize Thruster Servo.
2015-02-13T00:29:47.573Z,1423787387.573 [ThrusterServo](INFO): Powering down
2015-02-13T00:29:47.574Z,1423787387.574 [SBIT](DEBUG): Uninitialize SBIT Component.
2015-02-13T00:29:47.574Z,1423787387.574 [IBIT](DEBUG): Uninitialize IBIT Component.
2015-02-13T00:29:47.574Z,1423787387.574 [CBIT](DEBUG): Uninitialize CBIT Component.
2015-02-13T00:29:47.606Z,1423787387.606 [controlThread ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.714Z,1423787387.714 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.759Z,1423787387.759 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2015-02-13T00:29:47.822Z,1423787387.822 [logger ThreadHandler](INFO): Thread cancelled.