Die Foren-SW läuft ohne erkennbare Probleme. Sollte doch etwas nicht funktionieren, bitte gerne hier jederzeit melden und wir kümmern uns zeitnah darum. Danke!

Fehler beim Erstellen eines Snapshots: msg.snapshot.error-QUIESCINGERROR.

Alles zum Thema vSphere 6, ESXi 6.0 und vCenter Server.

Moderatoren: irix, continuum, Dayworker

Member
Beiträge: 155
Registriert: 31.01.2014, 12:08

Fehler beim Erstellen eines Snapshots: msg.snapshot.error-QUIESCINGERROR.

Beitragvon lord_icon » 07.09.2017, 10:27

Moinz,

ich hab n komisches Problem.
ein Win Server 2012 R2 Gast lässt sich über Acronis nicht Backupen. Bei weitere ca. 12 Gäste hingegen klappt es.

Der Fehler im vSphere Client 6.0 lautet immer:
Fehler beim Erstellen eines Snapshots: msg.snapshot.error-QUIESCINGERROR.

Was aber so nicht korrekt ist. Denn wenn ich händisch ein Snapshot erstelle, dann erfolgt dieser einwandfrei.
Mitunter hab ich die Kiste auch mal aus vCenter getrennt, falls hier was querschießt. Aber leider auch ohne erfolg.

Einer ein Plan, was ich noch versuchen könnte ?
P.s. vmtols wurden schon mal deinstalliert und wieder installiert.
Danke


Die Log von der Kiste lautet:
2017-09-07T08:17:35.601Z| vmx| I120: VigorTransportProcessClientPayload: opID=07bdbf6b seq=131927: Receiving HotPlugManager.BeginBatch request.
2017-09-07T08:17:35.601Z| vmx| I120: VigorTransport_ServerSendResponse opID=07bdbf6b seq=131927: Completed HotPlugManager request.
2017-09-07T08:17:35.659Z| vmx| I120: VigorTransportProcessClientPayload: opID=07bdbf6b seq=131931: Receiving Disk.SetCtkEnabled request.
2017-09-07T08:17:35.659Z| vmx| A115: ConfigDB: Setting scsi0:0.ctkEnabled = "TRUE"
2017-09-07T08:17:35.671Z| vmx| I120: VigorTransport_ServerSendResponse opID=07bdbf6b seq=131931: Completed DiskEarlyDevice request.
2017-09-07T08:17:35.675Z| vmx| I120: VigorTransportProcessClientPayload: opID=07bdbf6b seq=131933: Receiving Disk.SetCtkEnabled request.
2017-09-07T08:17:35.675Z| vmx| A115: ConfigDB: Setting scsi0:2.ctkEnabled = "TRUE"
2017-09-07T08:17:35.687Z| vmx| I120: VigorTransport_ServerSendResponse opID=07bdbf6b seq=131933: Completed DiskEarlyDevice request.
2017-09-07T08:17:35.690Z| vmx| I120: VigorTransportProcessClientPayload: opID=07bdbf6b seq=131935: Receiving HotPlugManager.EndBatch request.
2017-09-07T08:17:35.691Z| vmx| I120: VigorTransport_ServerSendResponse opID=07bdbf6b seq=131935: Completed HotPlugManager request.
2017-09-07T08:17:35.756Z| vcpu-0| I120: TOOLS call to unity.show.taskbar failed.
2017-09-07T08:17:35.756Z| vcpu-0| I120: TOOLS call to unity.show.taskbar failed.
2017-09-07T08:17:39.423Z| vcpu-0| I120: Guest: vsep: AUDIT: VFileFltPostOpCreate : File (\Windows\System32\Tasks\Optimize Start Menu Cache Files-S-1-5-21-26589540-1655198647-3647399699-500) in a transaction, ignore
2017-09-07T08:17:39.424Z| vcpu-0| I120: Guest: vsep: AUDIT: VFileFltPostOpCreate : File (\Windows\System32\Tasks\Optimize Start Menu Cache Files-S-1-5-21-26589540-1655198647-3647399699-500) in a transaction, ignore
2017-09-07T08:17:39.424Z| vcpu-0| I120: Guest: vsep: AUDIT: VFileFltPostOpCreate : File (\Windows\System32\Tasks\Optimize Start Menu Cache Files-S-1-5-21-26589540-1655198647-3647399699-500) in a transaction, ignore
2017-09-07T08:17:39.426Z| vcpu-0| I120: Guest: vsep: AUDIT: VFileFltPostOpCreate : File (\Windows\System32\Tasks\Optimize Start Menu Cache Files-S-1-5-21-26589540-1655198647-3647399699-500) in a transaction, ignore
2017-09-07T08:17:40.593Z| vcpu-0| I120: Guest: vsep: AUDIT: VFileFltPostOpCreate : File (\Windows\System32\Tasks\Microsoft\Windows\.NET Framework\.NET Framework NGEN v4.0.30319 64) in a transaction, ignore
2017-09-07T08:17:40.594Z| vcpu-0| I120: Guest: vsep: AUDIT: VFileFltPostOpCreate : File (\Windows\System32\Tasks\Microsoft\Windows\.NET Framework\.NET Framework NGEN v4.0.30319 64) in a transaction, ignore
2017-09-07T08:17:40.595Z| vcpu-0| I120: Guest: vsep: AUDIT: VFileFltPostOpCreate : File (\Windows\System32\Tasks\Microsoft\Windows\.NET Framework\.NET Framework NGEN v4.0.30319 64) in a transaction, ignore
2017-09-07T08:17:40.595Z| vcpu-0| I120: Guest: vsep: AUDIT: VFileFltPostOpCreate : File (\Windows\System32\Tasks\Microsoft\Windows\.NET Framework\.NET Framework NGEN v4.0.30319 64) in a transaction, ignore
2017-09-07T08:17:41.643Z| vcpu-2| I120: Guest: vsep: AUDIT: VFileFltPostOpCreate : File (\Windows\System32\Tasks\Microsoft\Windows\.NET Framework\.NET Framework NGEN v4.0.30319) in a transaction, ignore
2017-09-07T08:17:41.644Z| vcpu-2| I120: Guest: vsep: AUDIT: VFileFltPostOpCreate : File (\Windows\System32\Tasks\Microsoft\Windows\.NET Framework\.NET Framework NGEN v4.0.30319) in a transaction, ignore
2017-09-07T08:17:41.645Z| vcpu-2| I120: Guest: vsep: AUDIT: VFileFltPostOpCreate : File (\Windows\System32\Tasks\Microsoft\Windows\.NET Framework\.NET Framework NGEN v4.0.30319) in a transaction, ignore
2017-09-07T08:17:41.646Z| vcpu-2| I120: Guest: vsep: AUDIT: VFileFltPostOpCreate : File (\Windows\System32\Tasks\Microsoft\Windows\.NET Framework\.NET Framework NGEN v4.0.30319) in a transaction, ignore
2017-09-07T08:17:42.440Z| vmx| I120: VigorTransportProcessClientPayload: opID=07bdbf8c seq=132073: Receiving Snapshot.Take request.
2017-09-07T08:17:42.440Z| vmx| I120: SnapshotVMX_TakeSnapshot start: 'Thu Sep 7 10:17:40 2017', deviceState=0, lazy=0, logging=0, quiesced=1, forceNative=0, tryNative=1, saveAllocMaps=0 cb=1910C590, cbData=32622110
2017-09-07T08:17:42.443Z| vmx| I120: DISKLIB-LIB_CREATE : DiskLibCreateCreateParam: vmfsSparse grain size is set to 1 for '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001.vmdk'
2017-09-07T08:17:42.444Z| vmx| I120: DISKLIB-LIB_CREATE : DiskLibCreateCreateParam: vmfsSparse grain size is set to 1 for '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001.vmdk'
2017-09-07T08:17:42.444Z| vmx| I120: SNAPSHOT: SnapshotPrepareTakeDoneCB: Prepare phase complete (The operation completed successfully).
2017-09-07T08:17:42.597Z| vcpu-0| I120: ToolsBackup: changing quiesce state: IDLE -> STARTED
2017-09-07T08:17:46.857Z| vmx| I120: Msg_Post: Warning
2017-09-07T08:17:46.857Z| vmx| I120: [msg.snapshot.quiesce.vmerr] The guest OS has reported an error during quiescing.
2017-09-07T08:17:46.857Z| vmx| I120+ The error code was: 5
2017-09-07T08:17:46.857Z| vmx| I120+ The error message was: 'VssSyncStart' operation failed: IDispatch error #8454 (0x80042306)
2017-09-07T08:17:46.857Z| vmx| I120: ----------------------------------------
2017-09-07T08:17:46.859Z| vmx| I120: Vigor_MessageRevoke: message 'msg.snapshot.quiesce.vmerr' (seq 2641570) is revoked
2017-09-07T08:17:46.859Z| vmx| I120: ToolsBackup: changing quiesce state: STARTED -> ERROR_WAIT
2017-09-07T08:17:48.856Z| vmx| I120: ToolsBackup: changing quiesce state: ERROR_WAIT -> IDLE
2017-09-07T08:17:48.856Z| vmx| I120: ToolsBackup: changing quiesce state: IDLE -> DONE
2017-09-07T08:17:48.856Z| vmx| I120: SnapshotVMXTakeSnapshotComplete: Done with snapshot 'Thu Sep 7 10:17:40 2017': 0
2017-09-07T08:17:48.856Z| vmx| I120: SnapshotVMXTakeSnapshotComplete: Snapshot 0 failed: Failed to quiesce the virtual machine (31).
2017-09-07T08:17:48.856Z| vmx| I120: VigorTransport_ServerSendResponse opID=07bdbf8c seq=132073: Completed Snapshot request.

Member
Beiträge: 155
Registriert: 31.01.2014, 12:08

Re: Fehler beim Erstellen eines Snapshots: msg.snapshot.error-QUIESCINGERROR.

Beitragvon lord_icon » 07.09.2017, 10:32

Nachtrag.... so sieht das Log für ein Snapshot aus, der händisch initiert worden ist. (nur der Vollständigkeit halber)



2017-09-07T08:29:18.731Z| vmx| I120: VigorTransportProcessClientPayload: opID=2D357DBE-00004C24-c447 seq=132888: Receiving Snapshot.Take request.
2017-09-07T08:29:18.731Z| vmx| I120: SnapshotVMX_TakeSnapshot start: 'test', deviceState=1, lazy=1, logging=0, quiesced=0, forceNative=0, tryNative=1, saveAllocMaps=0 cb=1910C590, cbData=323EA220
2017-09-07T08:29:18.760Z| vmx| I120: DISKLIB-LIB_CREATE : DiskLibCreateCreateParam: vmfsSparse grain size is set to 1 for '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001.vmdk'
2017-09-07T08:29:18.761Z| vmx| I120: DISKLIB-LIB_CREATE : DiskLibCreateCreateParam: vmfsSparse grain size is set to 1 for '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001.vmdk'
2017-09-07T08:29:18.761Z| vmx| I120: SNAPSHOT: SnapshotPrepareTakeDoneCB: Prepare phase complete (The operation completed successfully).
2017-09-07T08:29:18.761Z| vcpu-0| I120: Destroying virtual dev for scsi0:0 vscsi=8332
2017-09-07T08:29:18.761Z| vcpu-0| I120: VMMon_VSCSIStopVports: No such target on adapter
2017-09-07T08:29:18.761Z| vcpu-0| I120: Destroying virtual dev for scsi0:2 vscsi=8333
2017-09-07T08:29:18.761Z| vcpu-0| I120: VMMon_VSCSIStopVports: No such target on adapter
2017-09-07T08:29:18.778Z| vcpu-0| I120: SnapshotVMXTakeSnapshotWork: Transition to mode 0.
2017-09-07T08:29:18.781Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-flat.vmdk" : open successful (65557) size = 80466280448, hd = 0. Type 3
2017-09-07T08:29:18.781Z| vcpu-0| I120: DISKLIB-LIB_BLOCKTRACK : Resuming change tracking.
2017-09-07T08:29:18.781Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-flat.vmdk" : closed.
2017-09-07T08:29:18.781Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-flat.vmdk" : open successful (65557) size = 536870912000, hd = 0. Type 3
2017-09-07T08:29:18.781Z| vcpu-0| I120: DISKLIB-LIB_BLOCKTRACK : Resuming change tracking.
2017-09-07T08:29:18.781Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-flat.vmdk" : closed.
2017-09-07T08:29:18.935Z| vcpu-0| I120: Progress -1% (msg.checkpoint.saveStatusWithName)
2017-09-07T08:29:18.935Z| vcpu-0| I120: Checkpointed in VMware ESX, 6.0.0, build-2494585, Linux Host
2017-09-07T08:29:18.983Z| vcpu-0| I120: Progress 0% (none)
2017-09-07T08:29:18.983Z| vcpu-0| I120: MainMem: Writing full memory image, '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Win-AD-Snapshot3.vmem'.
2017-09-07T08:29:19.037Z| vcpu-0| I120: GuestRpc: Reinitializing Channel 0(toolbox)
2017-09-07T08:29:19.037Z| vcpu-0| I120: GuestMsg: Channel 0, Cannot unpost because the previous post is already completed
2017-09-07T08:29:19.038Z| vcpu-0| I120: GuestRpc: Reinitializing Channel 1(toolbox-dnd)
2017-09-07T08:29:19.038Z| vcpu-0| I120: GuestMsg: Channel 1, Cannot unpost because the previous post is already completed
2017-09-07T08:29:19.126Z| vcpu-0| I120: Progress 101% (none)
2017-09-07T08:29:19.126Z| vcpu-0| I120: Closing all the disks of the VM.
2017-09-07T08:29:19.126Z| vcpu-0| I120: Closing disk scsi0:2
2017-09-07T08:29:19.148Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-flat.vmdk" : closed.
2017-09-07T08:29:19.148Z| vcpu-0| I120: Closing disk scsi0:0
2017-09-07T08:29:19.155Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-flat.vmdk" : closed.
2017-09-07T08:29:19.156Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-flat.vmdk" : open successful (29) size = 80466280448, hd = 0. Type 3
2017-09-07T08:29:19.156Z| vcpu-0| I120: DISKLIB-LIB_BLOCKTRACK : Resuming change tracking.
2017-09-07T08:29:19.156Z| vcpu-0| I120: DISKLIB-LIB_CREATE : DiskLibCreateCreateParam: vmfsSparse grain size is set to 1 for '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001.vmdk'
2017-09-07T08:29:19.157Z| vcpu-0| I120: DISKLIB-LIB_CREATE : CREATE CHILD: "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001.vmdk" -- vmfsSparse cowGran=1 allocType=0 policy=''
2017-09-07T08:29:19.157Z| vcpu-0| I120: DISKLIB-LIB_CREATE : CREATE-CHILD: Creating disk backed by 'default'
2017-09-07T08:29:19.162Z| vcpu-0| I120: DISKLIB-VMFS_SPARSE : VmfsSparseExtentCreate: "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001-delta.vmdk" : success
2017-09-07T08:29:19.163Z| vcpu-0| I120: DISKLIB-DSCPTR: "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001.vmdk" : creation successful.
2017-09-07T08:29:19.166Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001-delta.vmdk" : open successful (17) size = 155648, hd = 0. Type 8
2017-09-07T08:29:19.269Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001-delta.vmdk" : closed.
2017-09-07T08:29:19.269Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-flat.vmdk" : closed.
2017-09-07T08:29:19.270Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-flat.vmdk" : open successful (29) size = 536870912000, hd = 0. Type 3
2017-09-07T08:29:19.270Z| vcpu-0| I120: DISKLIB-LIB_BLOCKTRACK : Resuming change tracking.
2017-09-07T08:29:19.271Z| vcpu-0| I120: DISKLIB-LIB_CREATE : DiskLibCreateCreateParam: vmfsSparse grain size is set to 1 for '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001.vmdk'
2017-09-07T08:29:19.271Z| vcpu-0| I120: DISKLIB-LIB_CREATE : CREATE CHILD: "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001.vmdk" -- vmfsSparse cowGran=1 allocType=0 policy=''
2017-09-07T08:29:19.271Z| vcpu-0| I120: DISKLIB-LIB_CREATE : CREATE-CHILD: Creating disk backed by 'default'
2017-09-07T08:29:19.276Z| vcpu-0| I120: DISKLIB-VMFS_SPARSE : VmfsSparseExtentCreate: "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001-delta.vmdk" : success
2017-09-07T08:29:19.277Z| vcpu-0| I120: DISKLIB-DSCPTR: "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001.vmdk" : creation successful.
2017-09-07T08:29:19.282Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001-delta.vmdk" : open successful (17) size = 1028096, hd = 0. Type 8
2017-09-07T08:29:19.372Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001-delta.vmdk" : closed.
2017-09-07T08:29:19.372Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-flat.vmdk" : closed.
2017-09-07T08:29:19.373Z| vcpu-0| A115: ConfigDB: Setting displayName = "Win-AD"
2017-09-07T08:29:19.373Z| vcpu-0| A115: ConfigDB: Setting scsi0:0.fileName = "Systemplatte-000001.vmdk"
2017-09-07T08:29:19.373Z| vcpu-0| A115: ConfigDB: Setting scsi0:2.fileName = "BACKUP_DATEN-000001.vmdk"
2017-09-07T08:29:19.395Z| vcpu-0| I120: Checkpoint_Unstun: vm stopped for 634470 us
2017-09-07T08:29:19.423Z| vcpu-0| I120: SCSI: switching scsi0 to push completion mode
2017-09-07T08:29:19.423Z| Worker#1| I120: MainMem: Begin lazy IO (1024000 pages, 0 done, 1 threads, bio = 0).
2017-09-07T08:29:19.425Z| vcpu-0| A115: ConfigDB: Setting scsi0:0.redo = ""
2017-09-07T08:29:19.425Z| vcpu-0| I120: DISK: OPEN scsi0:0 '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001.vmdk' persistent R[]
2017-09-07T08:29:19.426Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001-delta.vmdk" : open successful (10) size = 155648, hd = 14098275. Type 8
2017-09-07T08:29:19.426Z| vcpu-0| I120: DISKLIB-DSCPTR: Opened [0]: "Systemplatte-000001-delta.vmdk" (0xa)
2017-09-07T08:29:19.426Z| vcpu-0| I120: DISKLIB-LINK : Opened '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001.vmdk' (0xa): vmfsSparse, 157160704 sectors / 74.9 GB.
2017-09-07T08:29:19.427Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-flat.vmdk" : open successful (14) size = 80466280448, hd = 14229348. Type 3
2017-09-07T08:29:19.427Z| vcpu-0| I120: DISKLIB-DSCPTR: Opened [0]: "Systemplatte-flat.vmdk" (0xe)
2017-09-07T08:29:19.427Z| vcpu-0| I120: DISKLIB-LINK : Opened '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte.vmdk' (0xe): vmfs, 157160704 sectors / 74.9 GB.
2017-09-07T08:29:19.427Z| vcpu-0| I120: DISKLIB-CHAINESX : ChainESXOpenSubChain: numLinks = 2, numSubChains = 1
2017-09-07T08:29:19.427Z| vcpu-0| I120: DISKLIB-CHAINESX : ChainESXOpenSubChain:(0) fid = 14229348, extentType = 2
2017-09-07T08:29:19.427Z| vcpu-0| I120: DISKLIB-CHAINESX : ChainESXOpenSubChain:(1) fid = 14098275, extentType = 0
2017-09-07T08:29:19.427Z| vcpu-0| I120: DISKLIB-LIB_BLOCKTRACK : Resuming change tracking.
2017-09-07T08:29:19.428Z| vcpu-0| I120: DISKLIB-CBT : Initializing ESX kernel change tracking for fid 25894761.
2017-09-07T08:29:19.428Z| vcpu-0| I120: DISKLIB-CBT : Creating cbt node 18b1f69-cbt failed with error Cannot allocate memory (0xbad0014, Out of memory).
2017-09-07T08:29:19.428Z| vcpu-0| W110: DISKLIB-LIB : Could not attach vmkernel change tracker: ESXi tracking filter failed (0x143c). Disk will be opened, but change tracking info vill be invalidated.
2017-09-07T08:29:19.428Z| vcpu-0| I120: DISKLIB-LIB : Opened "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001.vmdk" (flags 0xa, type vmfs).
2017-09-07T08:29:19.428Z| vcpu-0| I120: DISK: Disk '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001.vmdk' has UUID '60 00 c2 9e 11 81 dc 83-5f 86 73 32 e4 af 02 ad'
2017-09-07T08:29:19.428Z| vcpu-0| I120: DISK: OPEN '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001.vmdk' Geo (9782/255/63) BIOS Geo (0/0/0)
2017-09-07T08:29:19.428Z| vcpu-0| I120: Creating virtual dev for scsi0:0
2017-09-07T08:29:19.428Z| vcpu-0| I120: DumpDiskInfo: scsi0:0 createType=11, capacity = 157160704, numLinks = 2, allocationType = 0
2017-09-07T08:29:19.428Z| vcpu-0| I120: SCSIDiskESXPopulateVDevDesc: Using FS backend
2017-09-07T08:29:19.428Z| vcpu-0| I120: DISKUTIL: scsi0:0 : geometry=9782/255/63
2017-09-07T08:29:19.428Z| vcpu-0| A115: ConfigDB: Setting scsi0:2.redo = ""
2017-09-07T08:29:19.428Z| vcpu-0| I120: DISK: OPEN scsi0:2 '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001.vmdk' persistent R[]
2017-09-07T08:29:19.429Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001-delta.vmdk" : open successful (10) size = 1028096, hd = 15933291. Type 8
2017-09-07T08:29:19.429Z| vcpu-0| I120: DISKLIB-DSCPTR: Opened [0]: "BACKUP_DATEN-000001-delta.vmdk" (0xa)
2017-09-07T08:29:19.429Z| vcpu-0| I120: DISKLIB-LINK : Opened '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001.vmdk' (0xa): vmfsSparse, 1048576000 sectors / 500 GB.
2017-09-07T08:29:19.430Z| vcpu-0| I120: DISKLIB-VMFS : "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-flat.vmdk" : open successful (14) size = 536870912000, hd = 48373612. Type 3
2017-09-07T08:29:19.430Z| vcpu-0| I120: DISKLIB-DSCPTR: Opened [0]: "BACKUP_DATEN-flat.vmdk" (0xe)
2017-09-07T08:29:19.430Z| vcpu-0| I120: DISKLIB-LINK : Opened '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN.vmdk' (0xe): vmfs, 1048576000 sectors / 500 GB.
2017-09-07T08:29:19.430Z| vcpu-0| I120: DISKLIB-CHAINESX : ChainESXOpenSubChain: numLinks = 2, numSubChains = 1
2017-09-07T08:29:19.430Z| vcpu-0| I120: DISKLIB-CHAINESX : ChainESXOpenSubChain:(0) fid = 48373612, extentType = 2
2017-09-07T08:29:19.430Z| vcpu-0| I120: DISKLIB-CHAINESX : ChainESXOpenSubChain:(1) fid = 15933291, extentType = 0
2017-09-07T08:29:19.431Z| vcpu-0| I120: DISKLIB-LIB_BLOCKTRACK : Resuming change tracking.
2017-09-07T08:29:19.432Z| vcpu-0| I120: DISKLIB-CBT : Initializing ESX kernel change tracking for fid 10624877.
2017-09-07T08:29:19.432Z| vcpu-0| I120: DISKLIB-CBT : Creating cbt node a21f6d-cbt failed with error Cannot allocate memory (0xbad0014, Out of memory).
2017-09-07T08:29:19.432Z| vcpu-0| W110: DISKLIB-LIB : Could not attach vmkernel change tracker: ESXi tracking filter failed (0x143c). Disk will be opened, but change tracking info vill be invalidated.
2017-09-07T08:29:19.432Z| vcpu-0| I120: DISKLIB-LIB : Opened "/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001.vmdk" (flags 0xa, type vmfs).
2017-09-07T08:29:19.432Z| vcpu-0| I120: DISK: Disk '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001.vmdk' has UUID '60 00 c2 9e c4 d7 41 75-a8 0d 3e 75 f6 0c 3a e2'
2017-09-07T08:29:19.432Z| vcpu-0| I120: DISK: OPEN '/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/BACKUP_DATEN-000001.vmdk' Geo (65270/255/63) BIOS Geo (0/0/0)
2017-09-07T08:29:19.432Z| vcpu-0| I120: Creating virtual dev for scsi0:2
2017-09-07T08:29:19.432Z| vcpu-0| I120: DumpDiskInfo: scsi0:2 createType=11, capacity = 1048576000, numLinks = 2, allocationType = 0
2017-09-07T08:29:19.432Z| vcpu-0| I120: SCSIDiskESXPopulateVDevDesc: Using FS backend
2017-09-07T08:29:19.432Z| vcpu-0| I120: DISKUTIL: scsi0:2 : geometry=65270/255/63
2017-09-07T08:29:19.433Z| vcpu-0| I120: SnapshotVMXTakeSnapshotWork: Transition to mode 2.
2017-09-07T08:29:19.433Z| vcpu-0| I120: SnapshotVMXTakeSnapshotWork: Initiated lazy snapshot 'test': 3
2017-09-07T08:29:21.341Z| vcpu-0| I120: GuestRpc: Channel 0, guest application toolbox.
2017-09-07T08:29:24.586Z| vcpu-2| I120: GuestRpc: Channel 1, guest application toolbox-dnd.
2017-09-07T08:29:24.599Z| vcpu-2| I120: TOOLS call to unity.show.taskbar failed.
2017-09-07T08:29:26.916Z| vmx| I120: GuestRpcSendTimedOut: message to toolbox timed out.
2017-09-07T08:29:27.334Z| vmx| I120: TOOLS autoupgrade protocol version 2
2017-09-07T08:29:27.351Z| vmx| I120: Vix: [303357 mainDispatch.c:4210]: VMAutomationReportPowerStateChange: Reporting power state change (opcode=2, err=0).
2017-09-07T08:29:27.685Z| vmx| I120: TOOLS Received tools.set.version rpc call, version = 9536.
2017-09-07T08:29:27.685Z| vmx| I120: ToolsSetVersionWork did nothing; new tools version (9536) matches old Tools version
2017-09-07T08:29:36.937Z| vcpu-2| I120: HBACommon: First write on scsi0:0.fileName='/vmfs/volumes/54c53c32-2b6afac8-a8c1-0cc47a120c16/Win-AD/Systemplatte-000001.vmdk'
2017-09-07T08:29:36.937Z| vcpu-2| I120: DDB: "longContentID" = "46586c4c919a898aac4b7e912172357b" (was "cb2d4c8d13da32137ee7f621f5b321a0")
2017-09-07T08:29:37.460Z| vcpu-2| I120: DISKLIB-CHAIN : DiskChainUpdateContentID: old=0xf5b321a0, new=0x2172357b (46586c4c919a898aac4b7e912172357b)
2017-09-07T08:29:54.445Z| Worker#1| I120: MainMem: End lazy IO (1024000 done, sync = 0, error = 0).
2017-09-07T08:29:54.447Z| vmx| I120: MainMem: Completed pending lazy checkpoint save (1).
2017-09-07T08:29:54.448Z| vmx| I120: SnapshotVMXTakeSnapshotWork: Transition to mode 1.
2017-09-07T08:29:54.448Z| vmx| I120: SnapshotVMXTakeSnapshotComplete: Done with snapshot 'test': 3
2017-09-07T08:29:54.448Z| vmx| I120: VigorTransport_ServerSendResponse opID=2D357DBE-00004C24-c447 seq=132888: Completed Snapshot request.

Experte
Beiträge: 1335
Registriert: 25.04.2009, 11:17
Wohnort: Thüringen

Re: Fehler beim Erstellen eines Snapshots: msg.snapshot.error-QUIESCINGERROR.

Beitragvon Supi » 07.09.2017, 11:11

Hallo Herr ?,

welchen Tools Version ist dem im Einsatz? Laut VMWare sollen die neuesten 10.1.10 das beheben. Kann ich für mich aber nicht bestätigen.

ich verlinke einfach mal meinen Thread aus dem VMTN bzw. einen anderen:

https://communities.vmware.com/thread/569334

https://communities.vmware.com/thread/533736

kurzform von mir: ich würde auf die Tools 9.10.15 wechseln.

Member
Beiträge: 155
Registriert: 31.01.2014, 12:08

Re: Fehler beim Erstellen eines Snapshots: msg.snapshot.error-QUIESCINGERROR.

Beitragvon lord_icon » 07.09.2017, 12:06

Supi hat geschrieben:welchen Tools Version ist dem im Einsatz?

Die, die on der Version 6.0 vom vShpere Client automaisch zur Verfügung gestellt wird.
Diese sind: Version 9.10.0, build-2476743

Supi hat geschrieben:Laut VMWare sollen die neuesten 10.1.10 das beheben.

Und diese sind VERMUTLICH erst ab esxi 6.5 oder höher Verfügbar (?)

King of the Hill
Beiträge: 12556
Registriert: 02.08.2008, 15:06
Wohnort: Hannover/Wuerzburg
Kontaktdaten:

Re: Fehler beim Erstellen eines Snapshots: msg.snapshot.error-QUIESCINGERROR.

Beitragvon irix » 07.09.2017, 12:42

lord_icon hat geschrieben:...
Was aber so nicht korrekt ist. Denn wenn ich händisch ein Snapshot erstelle, dann erfolgt dieser einwandfrei.
..


Das nehme ich dir so nicht ab. Bitte drauf achten das beim "haendischen" auch Quiescing aktiviert wurde. Der Default ist es nicht und bei mir klappt dann auch in 99.99% der Versuche der manuelle nicht.

Ansonsten... du bist nicht alleine mit dem Problem ;)
- Obwohl alle VMs aus dem gleiche Template kommen tritt das Problem dann spaeter mal auf. Bevorzugt bei VMs mit vielen vDISKS bzw. Grossen
- Nach einem erfolglosen Snapshotversuch sieht man im vCenter den Tools Status als "not running" oder "unbekannt"
- Obigen und andere Fehler hat VMware mal vor langer Zeit in die Tools eingebaut. Loesung war Downgrade bzw. die 10.1.10 (verwenden wir auch). Einfach die *.exe herunterladen und installieren
- Wir haben aus der Vergangenheit Quiescing Scripte in die VM Guest. Es gibt auch die Option das Backprodukte diese hinterlegen. Diese machen aber eine Fehlerausgabe was VMware veranlasst den Snapshotversuch sofort zu beenden. Suche mal in c:\windows\ nach *post* oder *freeze*. Es gab eine Zeitlang aber auch einen anderen Ablageort fuer die Scripte und sie sind mit 6.x wieder zurueck gerudert und Suche beide Standorte ab.

Gruss
Joerg

Member
Beiträge: 155
Registriert: 31.01.2014, 12:08

Re: Fehler beim Erstellen eines Snapshots: msg.snapshot.error-QUIESCINGERROR.

Beitragvon lord_icon » 07.09.2017, 12:51

Oki... 10.1.10 hab ich als Tools installiert.
Lieder schafft es Acronis nachwievor nicht ein Backup agentenlos zu erstellen.

Ich hab jetzt erstmal den Win-Agent installiert um morgen nicht wieder x-Fehler Mails zu bekommen.
Wenn ich nicht alleine mit diesen Problem bin, dann bin ich schon mal beruhigt. Dann gehe ich mal davon aus, dass das irgendwann mal behoben wird.
Solange kann ich mit der agenten-Lösung leben... auch wenn es hier langsamer ist.

Experte
Beiträge: 1335
Registriert: 25.04.2009, 11:17
Wohnort: Thüringen

Re: Fehler beim Erstellen eines Snapshots: msg.snapshot.error-QUIESCINGERROR.

Beitragvon Supi » 07.09.2017, 13:16

Hallo Joerg und lord_icon,

bei mir und der einen 2012R2 VM klappt es leider mit den neuen Tools nicht. Daher der Hinweis auf die alten Tools.
Bei zwei weiteren Server 2012R2 VMs gibts die Probleme jedoch nicht.

hier zu finden 9.10.5 : https://packages.vmware.com/tools/esx/6 ... index.html

Einzig das Downgrade ist tricky. Also deinstallieren, nicht gleich neustart. Erst die alten Tools dann installieren und erst dann reboot.
Ich hatte wegen falscher Reihenfolge mal die VM mit dem Exchange rebootet und dann nur ein Boot-LW C: , da die Laufwerke D und E "paravirtuell" waren. Böser fehler.

In den verlinkten VMTN Threads sind auch noch ein paar Ratschläge wie Dienste beenden etc. Vielleicht hilft davon einer.

King of the Hill
Beiträge: 12556
Registriert: 02.08.2008, 15:06
Wohnort: Hannover/Wuerzburg
Kontaktdaten:

Re: Fehler beim Erstellen eines Snapshots: msg.snapshot.error-QUIESCINGERROR.

Beitragvon irix » 07.09.2017, 13:32

Ja.. wer den PARA SCSI in Verwendung hat (so wie wir hier) der saegt erstmal an dem Ast auf dem er sitzt. Wir wandeln dann vorher wieder auf LSI SAS um sofern wir die Tools mal deinstallieren muessen (das kam aber nur 1-2x vor in den vielen Jahren). Bis dato hat uns imer der Schritt nach vorne gerettet und da wo noch kein intelligentes Backup im Einsatz ist da deaktivieren wir dann notgedrungen das Quiescing fuer die VM.

@ lord_icon,
ist in der VM irgendeine Windows App drin die sich in VSS einklinkt? Was sagen das Windows Eventlog und was zeigt "vssadmin list writer"?

Gruss
Joerg

Experte
Beiträge: 1776
Registriert: 04.10.2011, 14:06

Re: Fehler beim Erstellen eines Snapshots: msg.snapshot.error-QUIESCINGERROR.

Beitragvon JustMe » 07.09.2017, 13:34

Bei dem "funktionierenden" Snapshot steht das, was irix schrieb, auch noch einmal bestaetigt drin:

2017-09-07T08:29:18.731Z| vmx| I120: SnapshotVMX_TakeSnapshot start: 'test', deviceState=1, lazy=1, logging=0, quiesced=0, forceNative=0, tryNative=1, saveAllocMaps=0 cb=1910C590, cbData=323EA220


:lol:

Der (Analyse-)Weg ueber den Volume Shadow Copy Service im Windows ist m.E. auf jeden Fall der richtige...


Zurück zu „vSphere 6.0“

Wer ist online?

Mitglieder in diesem Forum: 0 Mitglieder und 1 Gast