2018/05/29 23:47:15 - currents01skq 4.8.0-36-generic #36~16.04.1-Ubuntu SMP Sun Feb 5 09:39:57 UTC 2017 x86_64 2018/05/29 23:47:15 - /dev/ttyUSB4 2018/05/29 23:47:15 - /dev/ttyUSB6 2018/05/29 23:47:15 - /dev/ttyUSB7 2018/05/29 23:47:15 - In CruiseSetup.init 2018/05/29 23:47:15 - About to run mainloop 2018/05/29 23:47:52 - adcptree.py /home/data/UDPrelay_test/proc/wh300 -d uhdas --configpath /home/data/UDPrelay_test/raw/config --cruisename UDPrelay_test 2018/05/29 23:47:52 - found adcp templates at /usr/local/lib/python2.7/dist-packages/pycurrents/adcp/templates otherdemo is /usr/local/lib/python2.7/dist-packages/pycurrents/adcp/templates/uhdas_template ** data type is uhdas making directory /home/data/UDPrelay_test/proc/wh300/adcpdb making directory /home/data/UDPrelay_test/proc/wh300/cal making directory /home/data/UDPrelay_test/proc/wh300/cal/watertrk making directory /home/data/UDPrelay_test/proc/wh300/cal/botmtrk making directory /home/data/UDPrelay_test/proc/wh300/cal/heading making directory /home/data/UDPrelay_test/proc/wh300/cal/rotate making directory /home/data/UDPrelay_test/proc/wh300/contour making directory /home/data/UDPrelay_test/proc/wh300/edit making directory /home/data/UDPrelay_test/proc/wh300/grid making directory /home/data/UDPrelay_test/proc/wh300/load making directory /home/data/UDPrelay_test/proc/wh300/nav making directory /home/data/UDPrelay_test/proc/wh300/quality making directory /home/data/UDPrelay_test/proc/wh300/ping making directory /home/data/UDPrelay_test/proc/wh300/scan making directory /home/data/UDPrelay_test/proc/wh300/stick making directory /home/data/UDPrelay_test/proc/wh300/vector - copying additional files for data type uhdas - config files for raw processing are in /home/data/UDPrelay_test/proc/wh300/config copying config files using this wildcard expansion: /home/data/UDPrelay_test/raw/config/UDPrelay_test* 2018/05/29 23:47:52 - adcptree.py /home/data/UDPrelay_test/proc/os150nb -d uhdas --configpath /home/data/UDPrelay_test/raw/config --cruisename UDPrelay_test 2018/05/29 23:47:52 - found adcp templates at /usr/local/lib/python2.7/dist-packages/pycurrents/adcp/templates otherdemo is /usr/local/lib/python2.7/dist-packages/pycurrents/adcp/templates/uhdas_template ** data type is uhdas making directory /home/data/UDPrelay_test/proc/os150nb/adcpdb making directory /home/data/UDPrelay_test/proc/os150nb/cal making directory /home/data/UDPrelay_test/proc/os150nb/cal/watertrk making directory /home/data/UDPrelay_test/proc/os150nb/cal/botmtrk making directory /home/data/UDPrelay_test/proc/os150nb/cal/heading making directory /home/data/UDPrelay_test/proc/os150nb/cal/rotate making directory /home/data/UDPrelay_test/proc/os150nb/contour making directory /home/data/UDPrelay_test/proc/os150nb/edit making directory /home/data/UDPrelay_test/proc/os150nb/grid making directory /home/data/UDPrelay_test/proc/os150nb/load making directory /home/data/UDPrelay_test/proc/os150nb/nav making directory /home/data/UDPrelay_test/proc/os150nb/quality making directory /home/data/UDPrelay_test/proc/os150nb/ping making directory /home/data/UDPrelay_test/proc/os150nb/scan making directory /home/data/UDPrelay_test/proc/os150nb/stick making directory /home/data/UDPrelay_test/proc/os150nb/vector - copying additional files for data type uhdas - config files for raw processing are in /home/data/UDPrelay_test/proc/os150nb/config copying config files using this wildcard expansion: /home/data/UDPrelay_test/raw/config/UDPrelay_test* 2018/05/29 23:47:52 - adcptree.py /home/data/UDPrelay_test/proc/os150bb -d uhdas --configpath /home/data/UDPrelay_test/raw/config --cruisename UDPrelay_test 2018/05/29 23:47:52 - found adcp templates at /usr/local/lib/python2.7/dist-packages/pycurrents/adcp/templates otherdemo is /usr/local/lib/python2.7/dist-packages/pycurrents/adcp/templates/uhdas_template ** data type is uhdas making directory /home/data/UDPrelay_test/proc/os150bb/adcpdb making directory /home/data/UDPrelay_test/proc/os150bb/cal making directory /home/data/UDPrelay_test/proc/os150bb/cal/watertrk making directory /home/data/UDPrelay_test/proc/os150bb/cal/botmtrk making directory /home/data/UDPrelay_test/proc/os150bb/cal/heading making directory /home/data/UDPrelay_test/proc/os150bb/cal/rotate making directory /home/data/UDPrelay_test/proc/os150bb/contour making directory /home/data/UDPrelay_test/proc/os150bb/edit making directory /home/data/UDPrelay_test/proc/os150bb/grid making directory /home/data/UDPrelay_test/proc/os150bb/load making directory /home/data/UDPrelay_test/proc/os150bb/nav making directory /home/data/UDPrelay_test/proc/os150bb/quality making directory /home/data/UDPrelay_test/proc/os150bb/ping making directory /home/data/UDPrelay_test/proc/os150bb/scan making directory /home/data/UDPrelay_test/proc/os150bb/stick making directory /home/data/UDPrelay_test/proc/os150bb/vector - copying additional files for data type uhdas - config files for raw processing are in /home/data/UDPrelay_test/proc/os150bb/config copying config files using this wildcard expansion: /home/data/UDPrelay_test/raw/config/UDPrelay_test* 2018/05/29 23:47:52 - adcptree.py /home/data/UDPrelay_test/proc/os75nb -d uhdas --configpath /home/data/UDPrelay_test/raw/config --cruisename UDPrelay_test 2018/05/29 23:47:52 - found adcp templates at /usr/local/lib/python2.7/dist-packages/pycurrents/adcp/templates otherdemo is /usr/local/lib/python2.7/dist-packages/pycurrents/adcp/templates/uhdas_template ** data type is uhdas making directory /home/data/UDPrelay_test/proc/os75nb/adcpdb making directory /home/data/UDPrelay_test/proc/os75nb/cal making directory /home/data/UDPrelay_test/proc/os75nb/cal/watertrk making directory /home/data/UDPrelay_test/proc/os75nb/cal/botmtrk making directory /home/data/UDPrelay_test/proc/os75nb/cal/heading making directory /home/data/UDPrelay_test/proc/os75nb/cal/rotate making directory /home/data/UDPrelay_test/proc/os75nb/contour making directory /home/data/UDPrelay_test/proc/os75nb/edit making directory /home/data/UDPrelay_test/proc/os75nb/grid making directory /home/data/UDPrelay_test/proc/os75nb/load making directory /home/data/UDPrelay_test/proc/os75nb/nav making directory /home/data/UDPrelay_test/proc/os75nb/quality making directory /home/data/UDPrelay_test/proc/os75nb/ping making directory /home/data/UDPrelay_test/proc/os75nb/scan making directory /home/data/UDPrelay_test/proc/os75nb/stick making directory /home/data/UDPrelay_test/proc/os75nb/vector - copying additional files for data type uhdas - config files for raw processing are in /home/data/UDPrelay_test/proc/os75nb/config copying config files using this wildcard expansion: /home/data/UDPrelay_test/raw/config/UDPrelay_test* 2018/05/29 23:47:52 - adcptree.py /home/data/UDPrelay_test/proc/os75bb -d uhdas --configpath /home/data/UDPrelay_test/raw/config --cruisename UDPrelay_test 2018/05/29 23:47:52 - found adcp templates at /usr/local/lib/python2.7/dist-packages/pycurrents/adcp/templates otherdemo is /usr/local/lib/python2.7/dist-packages/pycurrents/adcp/templates/uhdas_template ** data type is uhdas making directory /home/data/UDPrelay_test/proc/os75bb/adcpdb making directory /home/data/UDPrelay_test/proc/os75bb/cal making directory /home/data/UDPrelay_test/proc/os75bb/cal/watertrk making directory /home/data/UDPrelay_test/proc/os75bb/cal/botmtrk making directory /home/data/UDPrelay_test/proc/os75bb/cal/heading making directory /home/data/UDPrelay_test/proc/os75bb/cal/rotate making directory /home/data/UDPrelay_test/proc/os75bb/contour making directory /home/data/UDPrelay_test/proc/os75bb/edit making directory /home/data/UDPrelay_test/proc/os75bb/grid making directory /home/data/UDPrelay_test/proc/os75bb/load making directory /home/data/UDPrelay_test/proc/os75bb/nav making directory /home/data/UDPrelay_test/proc/os75bb/quality making directory /home/data/UDPrelay_test/proc/os75bb/ping making directory /home/data/UDPrelay_test/proc/os75bb/scan making directory /home/data/UDPrelay_test/proc/os75bb/stick making directory /home/data/UDPrelay_test/proc/os75bb/vector - copying additional files for data type uhdas - config files for raw processing are in /home/data/UDPrelay_test/proc/os75bb/config copying config files using this wildcard expansion: /home/data/UDPrelay_test/raw/config/UDPrelay_test* 2018/05/29 23:47:52 - /bin/rm -Rf /home/adcp/www; uhdas_webgen.py -s skq --website /home/adcp/www 2018/05/29 23:47:53 - Starting procsetup scriptpath is /usr/local/currents/bin shipkey is skq about to run: rsync -auxl --exclude=calibrations --exclude=Checks_and_Instructions --exclude=index_bodies /usr/local/lib/python2.7/dist-packages/onship/wwwcore/ /home/adcp/www copying ADCP sikuliaq checklist from /home/adcp/www/programs/onship/wwwcore/Checks_and_Instructions/ADCP_checklist.pdf copying /home/adcp/config/proc_cfg.py to /home/adcp/www/configs/proc_cfg.py.txt copying /home/adcp/config/sensor_cfg.py to /home/adcp/www/configs/sensor_cfg.py.txt copying /home/adcp/config/cmdfiles/wh300_default.cmd to /home/adcp/www/configs/wh300_default.cmd.txt copying /home/adcp/config/cmdfiles/os150_default.cmd to /home/adcp/www/configs/os150_default.cmd.txt copying /home/adcp/config/cmdfiles/os75_default.cmd to /home/adcp/www/configs/os75_default.cmd.txt Web_speedlog IP is 10.1.0.53 generating /home/adcp/www/figures/lastfew.html ptype=lastfewvec title=last few vectors inst=wh300 inst=os150nb inst=os150bb inst=os75nb inst=os75bb web page for Sikuliaq found instruments: ['wh300', 'os150', 'os75'] found sonars (instping): ['wh300', 'os150nb', 'os150bb', 'os75nb', 'os75bb'] found attitude devices: ['seapath', 'gyro2'] 2018/05/29 23:47:54 - Entering buildLoggers 2018/05/29 23:47:54 - device: 2018/05/29 23:47:54 - ttyUSB3 2018/05/29 23:47:54 - -f skq -F -m 1 -H 2 -e raw -lE -c -O -I 2018/05/29 23:47:54 - Created output directory with mode 775 2018/05/29 23:47:54 - device: 2018/05/29 23:47:54 - ttyUSB3 2018/05/29 23:47:54 - -f skq -F -m 1 -H 2 -e raw -lE -c -O -I -Z tcp://127.0.0.1:38010 2018/05/29 23:47:54 - Created output directory with mode 775 2018/05/29 23:47:54 - device: 2018/05/29 23:47:54 - ttyUSB3 2018/05/29 23:47:54 - -f skq -F -m 1 -H 2 -e raw -lE -c -O -I 2018/05/29 23:47:54 - Created output directory with mode 775 2018/05/29 23:47:54 - device: 2018/05/29 23:47:54 - ttyUSB3 2018/05/29 23:47:54 - -f skq -F -m 1 -H 2 -e sea -c -Y2 2018/05/29 23:47:54 - Created output directory with mode 775 2018/05/29 23:47:54 - device: 2018/05/29 23:47:54 - ttyUSB3 2018/05/29 23:47:54 - -f skq -F -m 1 -H 2 -e gps -c -Y2 2018/05/29 23:47:54 - Created output directory with mode 775 2018/05/29 23:47:54 - device: 2018/05/29 23:47:54 - ttyUSB3 2018/05/29 23:47:54 - -f skq -F -m 1 -H 2 -e hdg -c -Y2 -s9 2018/05/29 23:47:54 - Created output directory with mode 775 2018/05/29 23:47:54 - device: 2018/05/29 23:47:54 - ttyUSB3 2018/05/29 23:47:54 - -f skq -F -m 1 -H 2 -e hdg -c -Y2 -s9 2018/05/29 23:47:54 - Created output directory with mode 775 2018/05/29 23:47:54 - >>>> C_ss enabled <<<<< 2018/05/29 23:47:54 - Leaving buildLoggers 2018/05/29 23:47:54 - Start Cruise 2018/05/29 23:48:05 - enter StartLogging, resume = 2018/05/29 23:48:05 - 0 2018/05/29 23:48:07 - TS? 2018/05/29 23:48:07 - TS180529234807 2018/05/29 23:48:07 - CR1 2018/05/29 23:48:08 - WD 111 00 0000 2018/05/29 23:48:08 - ND 111 00 0000 2018/05/29 23:48:08 - EA04500 2018/05/29 23:48:08 - NP1 2018/05/29 23:48:08 - NN60 2018/05/29 23:48:08 - NS800 2018/05/29 23:48:08 - NF1200 2018/05/29 23:48:08 - WP0 2018/05/29 23:48:08 - WN80 2018/05/29 23:48:08 - WS400 2018/05/29 23:48:08 - WF1200 2018/05/29 23:48:08 - BP0 2018/05/29 23:48:08 - BX5000 2018/05/29 23:48:08 - TP00:01.10 2018/05/29 23:48:08 - CX0,0 2018/05/29 23:48:08 - B? 2018/05/29 23:48:09 - N? 2018/05/29 23:48:10 - W? 2018/05/29 23:48:12 - E? 2018/05/29 23:48:14 - C? 2018/05/29 23:48:16 - T? 2018/05/29 23:48:16 - PS0 2018/05/29 23:48:17 - In os_check_D_params 2018/05/29 23:48:17 - in os_check_D_params: 111000000 2018/05/29 23:48:17 - in os_check_D_params: 111000000 2018/05/29 23:48:17 - CF11110 2018/05/29 23:48:18 - Entering Loggers.start_logging 2018/05/29 23:48:18 - /usr/local/bin/ser_bin -y 2018 -P ttyUSB6 -b 38400 -d /home/data/UDPrelay_test/raw/os150 -i /tmp/SerialLogger/inpipe.ttyUSB6 -o /tmp/SerialLogger/outpipe.ttyUSB6 -T 1527637698 -f skq -F -m 1 -H 2 -e raw -lE -c -O -I -Z tcp://127.0.0.1:38010 2> /tmp/stderr.ttyUSB6 & 2018/05/29 23:48:18 - /usr/local/bin/ser_asc -y 2018 -P ttyUSB0 -b 9600 -d /home/data/UDPrelay_test/raw/seapath -i /tmp/SerialLogger/inpipe.ttyUSB0 -o /tmp/SerialLogger/outpipe.ttyUSB0 -T 1527637698 -f skq -F -m 1 -H 2 -e sea -c -Y2 '$GPGGA' '$PSXN,20' '$PSXN,23' '$GPHDT' 2> /tmp/stderr.ttyUSB0 & 2018/05/29 23:48:19 - /usr/local/bin/ser_asc -y 2018 -P ttyUSB1 -b 9600 -d /home/data/UDPrelay_test/raw/cnav -i /tmp/SerialLogger/inpipe.ttyUSB1 -o /tmp/SerialLogger/outpipe.ttyUSB1 -T 1527637698 -f skq -F -m 1 -H 2 -e gps -c -Y2 '' 2> /tmp/stderr.ttyUSB1 & 2018/05/29 23:48:19 - /usr/local/bin/ser_asc -y 2018 -P ttyUSB2 -b 4800 -d /home/data/UDPrelay_test/raw/gyro1 -i /tmp/SerialLogger/inpipe.ttyUSB2 -o /tmp/SerialLogger/outpipe.ttyUSB2 -T 1527637698 -f skq -F -m 1 -H 2 -e hdg -c -Y2 -s9 '$HEHDT' 2> /tmp/stderr.ttyUSB2 & 2018/05/29 23:48:19 - /usr/local/bin/ser_asc -y 2018 -P ttyUSB3 -b 4800 -d /home/data/UDPrelay_test/raw/gyro2 -i /tmp/SerialLogger/inpipe.ttyUSB3 -o /tmp/SerialLogger/outpipe.ttyUSB3 -T 1527637698 -f skq -F -m 1 -H 2 -e hdg -c -Y2 -s9 '$HEHDT' 2> /tmp/stderr.ttyUSB3 & 2018/05/29 23:48:19 - Leaving Loggers.start_logging 2018/05/29 23:48:19 - Updated SVs_present from SVs and wrote cmds 2018/05/29 23:48:19 - 0 2018/05/29 23:48:19 - Updated SVs_present from SVs and wrote cmds 2018/05/29 23:48:19 - 1 2018/05/29 23:48:19 - Updated SVs_present from SVs and wrote cmds 2018/05/29 23:48:19 - 2 2018/05/29 23:48:19 - Running /usr/local/currents/bin/DAS_while_logging.py 2018/05/29 23:48:19 - Exiting StartLogging 2018/05/30 00:27:53 - Entering StopLogging 2018/05/30 00:27:55 - Loggers.check_stop_logging: all log processes ended 2018/05/30 00:27:59 - TS? 2018/05/30 00:27:59 - Removed /home/adcp/flags/DAS.logging 2018/05/30 00:27:59 - Exiting StopLogging 2018/05/31 18:56:04 - Exception in Tk callback Function: > (type: ) Args: () Traceback (innermost last): File "/usr/lib/python2.7/dist-packages/Pmw/Pmw_1_3/lib/PmwBase.py", line 1747, in __call__ return apply(self.func, args) File "/usr/local/lib/python2.7/dist-packages/uhdas/serial/oswh_term.py", line 155, in wakeup self.slow_wakeup() File "/usr/local/lib/python2.7/dist-packages/uhdas/serial/oswh_term.py", line 126, in slow_wakeup self.waitfor(b'>', timeout=3, quiet=0.5) File "/usr/local/lib/python2.7/dist-packages/uhdas/serial/tk_terminal.py", line 286, in waitfor raise Timeout : 2018/05/31 18:56:17 - TS? 2018/05/31 19:02:14 - enter StartLogging, resume = 2018/05/31 19:02:14 - 0 2018/05/31 19:02:19 - TS? 2018/05/31 19:02:19 - TS18/05/31, 19:02:19 2018/05/31 19:02:19 - CR1 2018/05/31 19:02:19 - CL0 2018/05/31 19:02:19 - WD 111 000 000 2018/05/31 19:02:19 - TE00:00:00.00 2018/05/31 19:02:19 - CF11110 2018/05/31 19:02:19 - EX00000 2018/05/31 19:02:19 - EZ1011101 2018/05/31 19:02:19 - CL0 2018/05/31 19:02:19 - CX1 2018/05/31 19:02:20 - CW0 2018/05/31 19:02:20 - SB0 2018/05/31 19:02:20 - WP1 2018/05/31 19:02:20 - WN70 2018/05/31 19:02:20 - WS200 2018/05/31 19:02:20 - WF200 2018/05/31 19:02:20 - BP1 2018/05/31 19:02:20 - BX2000 2018/05/31 19:02:20 - WB0 2018/05/31 19:02:20 - WV550 2018/05/31 19:02:20 - TP00:00.00 2018/05/31 19:02:20 - B? 2018/05/31 19:02:20 - W? 2018/05/31 19:02:21 - E? 2018/05/31 19:02:22 - C? 2018/05/31 19:02:23 - T? 2018/05/31 19:02:25 - PS0 2018/05/31 19:02:27 - In whbb_check_D_params 2018/05/31 19:02:27 - CF11110 2018/05/31 19:02:28 - Entering Loggers.start_logging 2018/05/31 19:02:28 - /usr/local/bin/ser_bin -y 2018 -P ttyUSB4 -b 38400 -d /home/data/UDPrelay_test/raw/wh300 -i /tmp/SerialLogger/inpipe.ttyUSB4 -o /tmp/SerialLogger/outpipe.ttyUSB4 -T 1527793348 -f skq -F -m 1 -H 2 -e raw -lE -c -O -I 2> /tmp/stderr.ttyUSB4 & 2018/05/31 19:02:28 - /usr/local/bin/ser_asc -y 2018 -P ttyUSB0 -b 9600 -d /home/data/UDPrelay_test/raw/seapath -i /tmp/SerialLogger/inpipe.ttyUSB0 -o /tmp/SerialLogger/outpipe.ttyUSB0 -T 1527793348 -f skq -F -m 1 -H 2 -e sea -c -Y2 '$GPGGA' '$PSXN,20' '$PSXN,23' '$GPHDT' 2> /tmp/stderr.ttyUSB0 & 2018/05/31 19:02:28 - /usr/local/bin/ser_asc -y 2018 -P ttyUSB1 -b 9600 -d /home/data/UDPrelay_test/raw/cnav -i /tmp/SerialLogger/inpipe.ttyUSB1 -o /tmp/SerialLogger/outpipe.ttyUSB1 -T 1527793348 -f skq -F -m 1 -H 2 -e gps -c -Y2 '' 2> /tmp/stderr.ttyUSB1 & 2018/05/31 19:02:29 - /usr/local/bin/ser_asc -y 2018 -P ttyUSB2 -b 4800 -d /home/data/UDPrelay_test/raw/gyro1 -i /tmp/SerialLogger/inpipe.ttyUSB2 -o /tmp/SerialLogger/outpipe.ttyUSB2 -T 1527793348 -f skq -F -m 1 -H 2 -e hdg -c -Y2 -s9 '$HEHDT' 2> /tmp/stderr.ttyUSB2 & 2018/05/31 19:02:29 - /usr/local/bin/ser_asc -y 2018 -P ttyUSB3 -b 4800 -d /home/data/UDPrelay_test/raw/gyro2 -i /tmp/SerialLogger/inpipe.ttyUSB3 -o /tmp/SerialLogger/outpipe.ttyUSB3 -T 1527793348 -f skq -F -m 1 -H 2 -e hdg -c -Y2 -s9 '$HEHDT' 2> /tmp/stderr.ttyUSB3 & 2018/05/31 19:02:29 - Leaving Loggers.start_logging 2018/05/31 19:02:29 - Updated SVs_present from SVs and wrote cmds 2018/05/31 19:02:29 - 0 2018/05/31 19:02:29 - Updated SVs_present from SVs and wrote cmds 2018/05/31 19:02:29 - 1 2018/05/31 19:02:29 - Updated SVs_present from SVs and wrote cmds 2018/05/31 19:02:29 - 2 2018/05/31 19:02:29 - Running /usr/local/currents/bin/DAS_while_logging.py 2018/05/31 19:02:29 - Exiting StartLogging 2018/05/31 19:10:08 - Entering StopLogging 2018/05/31 19:10:10 - Loggers.check_stop_logging: all log processes ended 2018/05/31 19:10:23 - Wakeup of wh300 timed out. 2018/05/31 19:10:23 - Removed /home/adcp/flags/DAS.logging 2018/05/31 19:10:23 - Exiting StopLogging 2018/05/31 23:31:44 - Ready to destroy_loggers. 2018/05/31 23:31:44 - After destroy_loggers. 2018/05/31 23:31:44 - cp -au /home/adcp/log/* /home/data/UDPrelay_test/raw/log/ 2018/05/31 23:31:44 - End Cruise 2018/05/31 23:32:11 - mainloop ended