Running bin\geopdvc.pl at Sat Dec 19 03:01:08 2009 on host solstice Command line: bin\geopdvc.pl -rov vnta -dive 3441 bin\geopdvc.pl: Getting Expedition object for diveno = 3441 and rname = vnta set_expd(): rov = vnta, diveno = 3441 set_expd(): $self->{EndDDD} = 294 set_expd(): $self->{StartEsecs} = 1256151840 set_expd(): $self->{EndEsecs} = 1256158200 set_expd(): $self->{EndDtg} = 10/21/2009 8:30:00 PM _readLogr(): Reading videologr data from 2009294datavislogr.dat.gz. _readLogr(): Expedition start & stop times are 1256151840 & 1256158200 _readLogr(): Flushing variable names: _readLogr(): esecs of file line[0] = 1256158204, self->{EndEsecs} = 1256158200 _readLogr(): #LOGHOST_SYSTEM_UTC = 635 _readLogr(): $LOGHOST_SYSTEM_UTC[beg] = 1256151842 _readLogr(): $LOGHOST_SYSTEM_UTC[end] = 1256158194 set_expd(): Calling _refineStartAndEndEsecs... refineStartAndEndEsecs(): LOGHOST_SYSTEM_UTC[0] = 1256151842 refineStartAndEndEsecs(): $LOGHOST_SYSTEM_UTC[end] = 1256158194 refineStartAndEndEsecs(): setting StartEsecs to 1256151840 refineStartAndEndEsecs(): setting EndEsecs to 1256152993 refineStartAndEndEsecs(): numMinBack = 2.78333333333333, numMinForward = 15.9 refineStartAndEndEsecs(): Refined StartEsecs = 1256152873, Refined EndEsecs = 1256157954 _readLogr(): Reading videologr data from 2009294datavislogr.dat.gz. _readLogr(): Expedition start & stop times are 1256152873 & 1256157954 _readLogr(): Flushing variable names: _readLogr(): esecs of file line[0] = 1256157964, self->{EndEsecs} = 1256157954 _readLogr(): #LOGHOST_SYSTEM_UTC = 507 _readLogr(): $LOGHOST_SYSTEM_UTC[beg] = 1256152883 _readLogr(): $LOGHOST_SYSTEM_UTC[end] = 1256157954 bin\geopdvc.pl: expdid = 4199 bin\geopdvc.pl: Calling rovNavCTDO to get raw nav data... rovnavCTDO(): calcUTM = 0 rovnavCTDO(): getRaw = 1 rovNav(): 1, calcUTM = 0 rovNav(): 2, getRaw = 1 rovNav(): calcUTM = 0 rovNav(): DDD = 294 (looping to 294) Does file exist?: \\tornado\TempNav\2009\vnta\nav2009294vntaedited.txt yes. EXPD.pm: editNav flag = rovNav(): Opening ROV nav data from \\tornado\TempNav\2009\vnta\nav2009294vnta.txt esecs, east, north, lat, lon, head, pres 1256153599, 0, 0, 36.779177, -121.958188, 158.3, 167.63 1256154100, 0, 0, 36.778423, -121.957855, 216.5, 353.58 1256154601, 0, 0, 36.778433, -121.957082, 261.2, 424.79 1256155102, 0, 0, 36.778407, -121.956118, 199.5, 352.86 1256155603, 0, 0, 36.778627, -121.956008, 270.5, 273.07 1256156104, 0, 0, 36.778855, -121.956613, 270.1, 193.86 1256156605, 0, 0, 36.779027, -121.956597, 290.3, 71.34 rovNav(): 294: 3602 in tList after reading from \\tornado\TempNav\2009\vnta\nav2009294vnta.txt 3602 in tList 3602 in {self->{rovT}} 3602 in {self->{rovH}} rovCTDO(): ROV CTDO start & stop times are 1256155950 & 1256154360 rovNavCTDO(): Looking up ROVCTDO data ('.'found, 'X' exceeds max iter.): ................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................ rovGDCListRefs(): dMedian = 269.83055768569 rovGDCListRefs(): dStats->sample_range = 419.615850874641 rovGDCListRefs(): returning (1st elements): 1256153055 36.780012 -121.957497 252.7 2.26313482481903 geopdcv.pl(): editedNav flag = 1 Using mbnavedit edited Navigation. rovnavCTDO(): calcUTM = 0 rovNav(): 1, calcUTM = 0 rovNav(): calcUTM = 0 rovNav(): DDD = 294 (looping to 294) Does file exist?: \\tornado\TempNav\2009\vnta\nav2009294vntaedited.txt yes. EXPD.pm: editNav flag = rovNav(): Opening ROV nav data from \\tornado\TempNav\2009\vnta\nav2009294vntaedited.txt esecs, east, north, lat, lon, head, pres 1256153599, 0, 0, 36.779186, -121.958206, 158.3, 167.63 1256154100, 0, 0, 36.778447, -121.957835, 216.5, 353.58 1256154601, 0, 0, 36.778463, -121.957088, 261.2, 424.79 1256155102, 0, 0, 36.778428, -121.956111, 199.5, 352.86 1256155603, 0, 0, 36.778616, -121.956016, 270.5, 273.07 1256156104, 0, 0, 36.778871, -121.956615, 270.1, 193.86 1256156605, 0, 0, 36.779029, -121.956601, 290.3, 71.34 rovNav(): 294: 3602 in tList after reading from \\tornado\TempNav\2009\vnta\nav2009294vntaedited.txt rovNav(): Initial # seconds to fill at beginning of dive = 182 starting at StartEsecs = 1256152873 rovNav(): Initial # seconds to fill at end of dive = 1191 ending at EndEsecs =1256157954 rovNav(): LOGHOST_SYSTEM_UTC[0] = 1256152883 rovNav(): $LOGHOST_SYSTEM_UTC[end] = 1256157954 rovNav(): numMinBack = 2.61666666666667, numMinForward = 15.9 rovNav(): Refined StartEsecs = 1256152873, Refined EndEsecs = 1256157954 rovNav(): Refined # seconds to fill at beginning of dive = 182 starting at StartEsecs = 1256152873 rovNav(): Refined # seconds to fill at end of dive = 1191 ending at EndEsecs =1256157954 rovNav(): num tList = 3602 rovNav(): num eList = 3602 rovNav(): Adding data to begining of dive from logr indices 0 .. 17 rovNav(): Adding data to end of dive from logr indices 388 .. 507 rovNav(): num in tList now = 3740 rovNav(): num in eList now = 3740 3740 in tList 3740 in {self->{rovT}} 3740 in {self->{rovH}} rovCTDO(): ROV CTDO start & stop times are 1256155950 & 1256154360 rovNavCTDO(): Looking up ROVCTDO data ('.'found, 'X' exceeds max iter.): XXXXXXXXXXXXXXXXXXXXXXX.....................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................................frameGrabs(): Can't get http://search.mbari.org/ARCHIVE/frameGrabs/Ventana/stills/2009/294/accesses.txt at bin\geopdvc.pl line 2382 ...................................................................................................................................................................................................................... rovGDCListRefs(): dMedian = 262.147871907717 rovGDCListRefs(): dStats->sample_range = 426.640760974085 rovGDCListRefs(): returning (1st elements): 1256152883 36.780170 -121.958548 260.1 -5 bin\geopdvc.pl: ------------------------------------------------------------------------------- hash{lat} = 36.77868300 hash{lon} = -121.95665200 latMin = 30.778683 latMax = 42.778683 Executing sql: SELECT Area, Latitude, Longitude FROM GeoOrigin WHERE Latitude BETWEEN 30.778683 AND 42.778683 AND Longitude BETWEEN -127.956652 AND -115.956652 Dive lat = 36.77868300, area = cencal bin\geopdvc.pl: Found area = cencal in GeoOrigin For midpoint lon = -121.95665200 & lat = 36.77868300 Using olon = -122 & olat = 36 bin\geopdvc.pl: Calling makeROVorig... inline_name = vnta3441rov_orig.wrl Making color lookup world... var = Light, vmin = 40, vmax = 100 val = 40, color = .8 .7 0 val = 70, color = .6 .5 0 val = 85, color = .1 .1 0 val = 100, color = 1 1 1 var = O2, vmin = 0.2, vmax = 5 val = 0.2, color = 1 1 1 val = 0.3, color = 1 1 .2 val = 0.5, color = 1 1 0 val = 0.7, color = 0 1 0 val = 5, color = 0 0 1 var = Sal, vmin = 33, vmax = 35 val = 33, color = 1 1 .1 val = 33.5, color = 1 1 0 val = 34, color = 1 0 0 val = 34.5, color = .2 1 0 val = 35, color = 0 1 0 var = Temp, vmin = 4, vmax = 15 val = 4, color = 0 0 1 val = 8, color = 1 1 0 val = 10, color = 0 1 0 val = 15, color = 1 0 0 World = geo2009/vnta/vnta3441lookup.wrl bin\geopdvc.pl: Getting ship nav... shipNav(): selecting for ShipName = ptlo shipNav(): $#{$self->{shipLat}} = 507 shipNav(): $#{$self->{shipLat}}[last] = 36.786012 Position subsampling set to 3 setROVcolorlines(): Assigning color line for Light... varColors = LightColors index0 = 0.3330 0.2864 0.0000 setROVcolorlines(): Assigning color line for O2... varColors = O2Colors index0 = 0 0 1 setROVcolorlines(): Assigning color line for Sal... varColors = SalColors index0 = 1.0000 1.0000 0.0634 setROVcolorlines(): Assigning color line for Temp... varColors = TempColors index0 = 0.9476 0.0524 0.0000 makeTracks(): n = 3741 makeTracks(): Looping through 507 point of ship position data... makeTracks(): posSubsample = 3 makeTracks(): Writing tracks file... makeTracks(): INFO $sname = inline_name = vnta3441tracks.wrl writeCtdPosFile(): Writing merged CTD Nav data to geo2009/vnta/vnta3441mergedCtdNav.txt... bin\geopdvc.pl: Annotations: annotations(): Executing sql: SELECT DISTINCT DateDiff(ss, '01/01/70', RecordedDate) AS Esecs, CONVERT(CHAR(8), RecordedDate, 1) + ' ' + SUBSTRING(CONVERT(CHAR(19), RecordedDate, 120), 12, 8) AS DateTime, VideoArchiveName AS TapeNum, TapeTimeCode, ConceptName, Image AS StillImageURL, Depth, Latitude, Longitude, CameraDirection AS Direction, ISNULL(Observer, '') AS Observer, AnnotationMode, ObservationID_FK AS ObservationID FROM dbo.Annotations WHERE (ShipName = 'Point Lobos') AND (RecordedDate BETWEEN '10/21/2009 7:24:00 PM' AND '10/21/2009 8:30:00 PM') OR (RovName = 'Ventana') AND (RecordedDate BETWEEN '10/21/2009 7:24:00 PM' AND '10/21/2009 8:30:00 PM') _findIndex(): Looking for epoch secs 1256154616 ... Found time 1256154615 after 6 iterations. >>> p = 1489: annotations(): 1489, 1256154616, 10/21/09 19:50:16, V3441-03HD, 02:09:33:02, physical object, http://search.mbari.org/ARCHIVE/frameGrabs/Ventana/images/3441/02_09_33_02.jpg, 421.170013427734, stationary, etp3, o, 20038370 _findIndex(): Looking for epoch secs 1256154619 ... Found time 1256154615 after 6 iterations. >>> p = 1489: annotations(): 1489, 1256154619, 10/21/09 19:50:19, V3441-03HD, 02:09:35:02, physical object, http://search.mbari.org/ARCHIVE/frameGrabs/Ventana/images/3441/02_09_35_02.jpg, 421.190002441406, stationary, etp3, o, 20038371 bin\geopdvc.pl: Calling placeAnnotations with every 10 annotation...frameGrabs(): Can't get http://search.mbari.org/ARCHIVE/frameGrabs/Ventana/stills/2009/294/accesses.txt at bin\geopdvc.pl line 625 inline_name = vnta3441anno10.wrl bin\geopdvc.pl: Calling placeAnnotations with every 2 annotation... placeAnnotations(): Placing annotation 2: Ancillary data = ["", "P: 427.5 db", "T: 6.657 C", "S: 34.183", "O: 0.471 ml/l", "L: 86.66 %"] inline_name = vnta3441anno02.wrl bin\geopdvc.pl: Calling placeAnnotations with every 1 annotation... placeAnnotations(): Placing annotation 1: physical object Ancillary data = ["physical object", "P: 427.5 db", "T: 6.657 C", "S: 34.183", "O: 0.471 ml/l", "L: 86.66 %"] placeAnnotations(): Placing annotation 2: Ancillary data = ["", "P: 427.5 db", "T: 6.657 C", "S: 34.183", "O: 0.471 ml/l", "L: 86.66 %"] inline_name = vnta3441anno01.wrl frameGrabs(): Getting images from http://search.mbari.org/ARCHIVE/frameGrabs/Ventana/stills/2009/vnta3441... frameGrabs(): matched 02_09_33_02 in [IMG] 02_09_33_02.jpg 23-Oct-2009 00:08 81k frameGrabs(): matched 02_09_35_02 in [IMG] 02_09_35_02.jpg 23-Oct-2009 00:08 79k iList = 02_09_33_02.jpg 02_09_35_02.jpg _findIndex(): Looking for epoch secs 1256154616 ... Found time 1256154615 after 6 iterations. >>> p = 1489: frameGrabs(): index = 1489 EXPD::frameGrabs(): 1489: Time=1256154615, Depth=423.91, Lat= 36.778462, Lon=-121.957054, Pres=427.5, Temp=6.657, Sal=34.183, O2=0.471, Light=86.66 _findIndex(): Looking for epoch secs 1256154619 ... Found time 1256154615 after 6 iterations. >>> p = 1489: frameGrabs(): index = 1489 EXPD::frameGrabs(): 1489: Time=1256154615, Depth=423.91, Lat= 36.778462, Lon=-121.957054, Pres=427.5, Temp=6.657, Sal=34.183, O2=0.471, Light=86.66 bin\geopdvc.pl: Number of images returned from expd->frameGrabs(every=>1)} = 2 bin\geopdvc.pl: Calling placeImages with every 10 image... placeImages(): Placing image 0 02_09_33_02.jpg 1256154616 fw= 0.0 cm XplaceImages(): indx = 1489, geoPosition = 36.778462, -121.957054, -421.224723435733, rovDepth = 421.224723435733 inline_name = vnta3441fg10.wrl bin\geopdvc.pl: Calling placeImages with every 2 image... placeImages(): Placing image 0 02_09_33_02.jpg 1256154616 fw= 0.0 cm XplaceImages(): indx = 1489, geoPosition = 36.778462, -121.957054, -421.224723435733, rovDepth = 421.224723435733 inline_name = vnta3441fg02.wrl bin\geopdvc.pl: Calling placeImages with every 1 image... placeImages(): Placing image 0 02_09_33_02.jpg 1256154616 fw= 0.0 cm XplaceImages(): indx = 1489, geoPosition = 36.778462, -121.957054, -421.224723435733, rovDepth = 421.224723435733 placeImages(): Placing image 1 02_09_35_02.jpg 1256154619 fw= 0.0 cm XplaceImages(): indx = 1489, geoPosition = 36.778462, -121.957054, -421.224723435733, rovDepth = 421.224723435733 inline_name = vnta3441fg01.wrl bin\geopdvc.pl: Samples: samples(): Executing sql: SELECT DateDiff(ss, '01/01/70', CollectionEventDtg) AS Esecs, CollectionVIMSConcept, FrameGrabImageURL, SampleID, CollectionRefName FROM vwCollSamplePerson WHERE (CollectionEventDTG BETWEEN '10/21/2009 7:24:00 PM' AND '10/21/2009 8:30:00 PM') AND ROVName = 'Ventana' ORDER BY CollectionEventDTG bin\geopdvc.pl: World = geo2009/vnta/vnta3441.wrl Adding record to ExpeditionData table... Executing sql: exec insertExpeditionData '3Dreplay','','',4199,'/3Dreplay/3D.asp?dives=vnta3441','vnta3441','','','',3441 Executing sql: UPDATE Dive SET DiveLatMid = 36.7787, DiveLonMid = -121.9567, DiveDepthMid = -262.1 WHERE RovName = 'vnta' AND DiveNumber = 3441