Dec 23 00:00:00 MSZone newsyslog[38973]: logfile turned over due to size>100K
Dec 23 00:00:00 MSZone syslog-ng[8083]: Configuration reload request received, reloading configuration;
Dec 23 00:00:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0000-1m"
Dec 23 00:00:37 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0000-2d"
Dec 23 00:00:57 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0000-1w"
Dec 23 00:01:18 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0000-2w"
Dec 23 00:01:24 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161220.2349-2d"
Dec 23 00:01:24 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161216.0000-1w"
Dec 23 00:15:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0015-2d"
Dec 23 00:15:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0004-2d"
Dec 23 00:30:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0030-2d"
Dec 23 00:30:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0019-2d"
Dec 23 00:45:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0045-2d"
Dec 23 00:45:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0034-2d"
Dec 23 01:00:18 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0100-2d"
Dec 23 01:00:38 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0100-1w"
Dec 23 01:00:45 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0049-2d"
Dec 23 01:00:45 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161216.0100-1w"
Dec 23 01:15:15 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0115-2d"
Dec 23 01:15:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0104-2d"
Dec 23 01:30:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0130-2d"
Dec 23 01:30:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0119-2d"
Dec 23 01:45:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0145-2d"
Dec 23 01:45:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0134-2d"
Dec 23 02:00:20 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0200-2d"
Dec 23 02:00:41 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0200-1w"
Dec 23 02:00:47 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0149-2d"
Dec 23 02:00:47 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161216.0200-1w"
Dec 23 02:15:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0215-2d"
Dec 23 02:15:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0204-2d"
Dec 23 02:30:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0230-2d"
Dec 23 02:30:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0219-2d"
Dec 23 02:45:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0245-2d"
Dec 23 02:45:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0234-2d"
Dec 23 03:00:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0300-2d"
Dec 23 03:00:36 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0300-1w"
Dec 23 03:00:43 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161216.0300-1w"
Dec 23 03:00:43 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0249-2d"
Dec 23 03:03:29 MSZone 	(da1:mps0:0:12:0): SYNCHRONIZE CACHE(10). CDB: 35 00 00 00 00 00 00 00 00 00 length 0 SMID 384 command timeout cm 0xfffffe0000af6800 ccb 0xfffff8017df82000
Dec 23 03:03:29 MSZone 	(noperiph:mps0:0:4294967295:0): SMID 1 Aborting command 0xfffffe0000af6800
Dec 23 03:03:29 MSZone mps0: Sending reset from mpssas_send_abort for target ID 12
Dec 23 03:03:29 MSZone 	(da1:mps0:0:12:0): SYNCHRONIZE CACHE(10). CDB: 35 00 00 00 00 00 00 00 00 00 length 0 SMID 492 command timeout cm 0xfffffe0000aff5c0 ccb 0xfffff8017a00c000
Dec 23 03:03:29 MSZone 	(da1:mps0:0:12:0): READ(16). CDB: 88 00 00 00 00 01 ac 03 81 88 00 00 00 08 00 00 length 4096 SMID 479 terminated ioc 804b scsi 0 state c xfer 0
Dec 23 03:03:29 MSZone 	(da1:mps0:0:12:0): READ(16). CDB: 88 00 00 00 00 01 ac 03 81 20 00 00 00 08 00 00 length 4096 SMID 558 terminated ioc 804b sc(da1:mps0:0:12:0): READ(16). CDB: 88 00 00 00 00 01 ac 03 81 88 00 00 00 08 00 00 
Dec 23 03:03:29 MSZone si 0 state c xfer 0
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): CAM status: CCB request completed with an error
Dec 23 03:03:29 MSZone 	(da1:mps0:0:12:0): READ(10). CDB: 28 00 08 57 27 f0 00 00 10 00 length 8192 SMID 629 terminated ioc 804b scsi 0 state c xfer (da1:0
Dec 23 03:03:29 MSZone mps0:0:	(da1:mps0:0:12:0): READ(16). CDB: 88 00 00 00 00 01 ac 03 81 a0 00 00 00 08 00 00 length 4096 SMID 838 terminated ioc 804b sc12:si 0 state c xfer 0
Dec 23 03:03:29 MSZone 0): 	(da1:mps0:0:12:0): WRITE(16). CDB: 8a 00 00 00 00 01 d3 c9 8d f8 00 00 00 08 00 00 length 4096 SMID 638 terminated ioc 804b sRetrying command
Dec 23 03:03:29 MSZone csi 0 state c xfer 0
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): READ(16). CDB: 88 00 00 00 00 01 ac 03 81 20 00 00 00 08 00 00 
Dec 23 03:03:29 MSZone 	(da1:mps0:0:12:0): SYNCHRONIZE CACHE(10). CDB: 35 00 00 00 00 00 00 00 00 00 length 0 SMID 492 terminated ioc 804b scsi 0 sta(da1:mps0:0:12:0): CAM status: CCB request completed with an error
Dec 23 03:03:29 MSZone te c xfer 0
Dec 23 03:03:29 MSZone (da1:mps0: mps0:0:Unfreezing devq for target ID 12
Dec 23 03:03:29 MSZone 12:0): Retrying command
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): READ(10). CDB: 28 00 08 57 27 f0 00 00 10 00 
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): CAM status: CCB request completed with an error
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): Retrying command
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): READ(16). CDB: 88 00 00 00 00 01 ac 03 81 a0 00 00 00 08 00 00 
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): CAM status: CCB request completed with an error
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): Retrying command
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): WRITE(16). CDB: 8a 00 00 00 00 01 d3 c9 8d f8 00 00 00 08 00 00 
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): CAM status: CCB request completed with an error
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): Retrying command
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): SYNCHRONIZE CACHE(10). CDB: 35 00 00 00 00 00 00 00 00 00 
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): CAM status: Command timeout
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): Retrying command
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): SYNCHRONIZE CACHE(10). CDB: 35 00 00 00 00 00 00 00 00 00 
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): CAM status: CCB request completed with an error
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): Retrying command
Dec 23 03:03:29 MSZone zfsd: CaseFile::Serialize: Unable to open /etc/zfs/cases/pool_9748705956247124262_vdev_12421844234995334238.case.
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): SYNCHRONIZE CACHE(10). CDB: 35 00 00 00 00 00 00 00 00 00 
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): CAM status: SCSI Status Error
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): SCSI status: Check Condition
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): SCSI sense: UNIT ATTENTION asc:29,0 (Power on, reset, or bus device reset occurred)
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): Error 6, Retries exhausted
Dec 23 03:03:29 MSZone (da1:mps0:0:12:0): Invalidating pack
Dec 23 03:03:29 MSZone GEOM_ELI: g_eli_write_done() failed (error=6) gptid/8fe51f02-bafd-11e6-a3e0-000c2957bde2.eli[WRITE(offset=4010175635456, length=8192)]
Dec 23 03:03:29 MSZone GEOM_ELI: g_eli_read_done() failed (error=6) gptid/8fe51f02-bafd-11e6-a3e0-000c2957bde2.eli[READ(offset=270336, length=8192)]
Dec 23 03:03:29 MSZone GEOM_ELI: g_eli_read_done() failed (error=6) gptid/8fe51f02-bafd-11e6-a3e0-000c2957bde2.eli[READ(offset=9998683086848, length=8192)]
Dec 23 03:03:29 MSZone GEOM_ELI: g_eli_read_done() failed (error=6) gptid/8fe51f02-bafd-11e6-a3e0-000c2957bde2.eli[READ(offset=9998683348992, length=8192)]
Dec 23 03:03:29 MSZone GEOM_ELI: g_eli_write_done() failed (error=6) gptid/8fe51f02-bafd-11e6-a3e0-000c2957bde2.eli[WRITE(offset=4016114958336, length=131072)]
Dec 23 03:03:30 MSZone zfsd: CaseFile::Serialize: Unable to open /etc/zfs/cases/pool_9748705956247124262_vdev_12421844234995334238.case.
Dec 23 03:03:30 MSZone zfsd: CaseFile::Serialize: Unable to open /etc/zfs/cases/pool_9748705956247124262_vdev_12421844234995334238.case.
Dec 23 03:03:30 MSZone GEOM_ELI: g_eli_read_done() failed (error=6) gptid/8fe51f02-bafd-11e6-a3e0-000c2957bde2.eli[READ(offset=270336, length=8192)]
Dec 23 03:03:30 MSZone GEOM_ELI: g_eli_read_done() failed (error=6) gptid/8fe51f02-bafd-11e6-a3e0-000c2957bde2.eli[READ(offset=9998683086848, length=8192)]
Dec 23 03:03:30 MSZone GEOM_ELI: g_eli_read_done() failed (error=6) gptid/8fe51f02-bafd-11e6-a3e0-000c2957bde2.eli[READ(offset=9998683348992, length=8192)]
Dec 23 07:00:20 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0700-2d"
Dec 23 07:00:41 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0700-1w"
Dec 23 07:00:47 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161216.0700-1w"
Dec 23 07:15:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0715-2d"
Dec 23 07:15:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0704-2d"
Dec 23 07:30:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0730-2d"
Dec 23 07:30:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0719-2d"
Dec 23 07:45:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0745-2d"
Dec 23 07:45:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0734-2d"
Dec 23 08:00:18 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0800-2d"
Dec 23 08:00:38 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0800-1w"
Dec 23 08:00:45 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0749-2d"
Dec 23 08:00:45 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161216.0800-1w"
Dec 23 08:15:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0815-2d"
Dec 23 08:15:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0804-2d"
Dec 23 08:30:15 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0830-2d"
Dec 23 08:30:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0819-2d"
Dec 23 08:45:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0845-2d"
Dec 23 08:45:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0834-2d"
Dec 23 09:00:18 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0900-2d"
Dec 23 09:00:40 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0900-1w"
Dec 23 09:00:47 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0849-2d"
Dec 23 09:00:47 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161216.0900-1w"
Dec 23 09:15:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0915-2d"
Dec 23 09:15:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0904-2d"
Dec 23 09:28:46 MSZone manage.py: [common.pipesubr:66] Popen()ing: /usr/local/bin/ixdiagnose -d /var/db/system/ixdiagnose -s -F
Dec 23 09:30:16 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs snapshot -r -o freenas:vmsynced=Y "MSZone-RAID@auto-20161223.0930-2d"
Dec 23 09:30:22 MSZone autosnap.py: [tools.autosnap:66] Popen()ing: /sbin/zfs destroy -r -d "MSZone-RAID@auto-20161221.0919-2d"
