derekruf
asked on
Veeam Backup - Freezing guest operating system (Veeam Guest agent Not Started)
Hello experts,
We're trying to backup our exchange server with Veeam backup and replication. We get the following error when trying to backup the exchange server. All other VM's seem to be backin fine on the same host...
Starting guest agent
Cannot connect to host [10.0.5.10] over VIX library. Login: [root]. GuestLogin: [sfyit\administrator].
Timeout in VixHost_Connect
Freezing guest operating system
Veeam Guest Agent is not started
Thanks in advance.
We're trying to backup our exchange server with Veeam backup and replication. We get the following error when trying to backup the exchange server. All other VM's seem to be backin fine on the same host...
Starting guest agent
Cannot connect to host [10.0.5.10] over VIX library. Login: [root]. GuestLogin: [sfyit\administrator].
Timeout in VixHost_Connect
Freezing guest operating system
Veeam Guest Agent is not started
Thanks in advance.
Looks like your logon credentials for the backup job may be incorrect? Have you changed your admin pwd recently in your environment? Have you set credentials up for your job properly? You should have a SSH acct, then elevate to root in your b/u job.
Regards,
~coolsport00
Regards,
~coolsport00
Hi
Yes many times this issue is regarding the local admin on the VM that is used to create or run this backup.
Jail
Yes many times this issue is regarding the local admin on the VM that is used to create or run this backup.
Jail
ASKER
Environment:
Veeam Virtual machine on a Server connected to a SAS SAN
Exchange Virtual Machine resides on another server local storage no connected to the SAN
Veeam backs up another virtual machine on the same server as the Exchange Virtual machine successfully. Credentials are confirmed and setup in Veeam.
Veeam Virtual machine on a Server connected to a SAS SAN
Exchange Virtual Machine resides on another server local storage no connected to the SAN
Veeam backs up another virtual machine on the same server as the Exchange Virtual machine successfully. Credentials are confirmed and setup in Veeam.
Hi
Both VMsbackup, the failed and the success, resides on the same Datastore?
This is a ESX with local storage? Where you have more than one VM, and some you can backup, and that VM Exchange you cannot?
Are the failed and the success backup VMs on the same Veeam Backup job?
All VMs belong to the same Domain? What type of admin are you using to do this backups? Is a local admin, or a domain admin?
What version of Veeam are you using?
Jail
Both VMsbackup, the failed and the success, resides on the same Datastore?
This is a ESX with local storage? Where you have more than one VM, and some you can backup, and that VM Exchange you cannot?
Are the failed and the success backup VMs on the same Veeam Backup job?
All VMs belong to the same Domain? What type of admin are you using to do this backups? Is a local admin, or a domain admin?
What version of Veeam are you using?
Jail
ASKER
Correct, both failed and success are on the same Datastore.
Correct, I can backup the sharepoint VM but not the exchange on the same ESXi box / Local Storage
I've tried adding the exchange to the successfull sharepoint job, when I do that it fails. I've also created a job just with the Exchange.
All Vm's belong to the same domain.
Domain admin,
V5.0.1.198
Correct, I can backup the sharepoint VM but not the exchange on the same ESXi box / Local Storage
I've tried adding the exchange to the successfull sharepoint job, when I do that it fails. I've also created a job just with the Exchange.
All Vm's belong to the same domain.
Domain admin,
V5.0.1.198
Hi
Strange.
Did you have any success backup on that VM? Or this is the first time that you are trying to backup this VM?
Did you look at the logs to check any issue or other error message?
Jail
Strange.
Did you have any success backup on that VM? Or this is the first time that you are trying to backup this VM?
Did you look at the logs to check any issue or other error message?
Jail
ASKER
This is the first time. I viewed the HTML log, no additional information.
I've setup Veeam on other networks and havent has any problems like this. Usually runs really smooth.
I've setup Veeam on other networks and havent has any problems like this. Usually runs really smooth.
Hi
Yes I have many Veeam backup Exchange VM without any issues.
Note the htlml logs, but there is one folder with all the logs.
Try to create a job and use a local admin user and check if this runs
Jail
Yes I have many Veeam backup Exchange VM without any issues.
Note the htlml logs, but there is one folder with all the logs.
Try to create a job and use a local admin user and check if this runs
Jail
ASKER
Here's the log file, One error that was a bit odd was:
13.01.2011 21:13:40] <01> Error [VssGAConn] Failed to connect. IP address not found. at Veeam.Backup.VssProvider.CVssGAConnection.ConnectViaRpc(IVeeamGAConnection connection, String[] ipAddresses, CCredentials vmCreds)
===================================================================
Starting new log
Log has been started by 'SFY-VEEAM01\Administrator' user (Non-interactive)
Logging level: [4 (AboveNormal)]
MachineName: [SFY-VEEAM01], OS: [Microsoft Windows NT 6.1.7600.0]
Process: [64 bit]
UTC offset: [-8h 0m], DaylightSavingTime: [False]
Module: [C:\Program Files\Veeam\Backup and Replication\Veeam.Backup.Manager.exe]. File version: [5.0.1.198], Assembly version: [5.0.1.0]
CPU: [Intel(R) Xeon(R) CPU E5630 @ 2.53GHz]
Memory: [4.00 GB]
Network Interface, Name: Local Area Connection, Description: Intel(R) PRO/1000 MT Network Connection, Interface Type: Ethernet, Operational Status: Up;
Unicast IPAddresses: 10.0.5.60;
Gateway IPAddresses: 10.0.5.254;
Network Interface, Name: Loopback Pseudo-Interface 1, Description: Software Loopback Interface 1, Interface Type: Loopback, Operational Status: Up;
Unicast IPAddresses: ::1; 127.0.0.1;
Network Interface, Name: isatap.{42D16860-B982-474D-BAD5-D9C48C1A405B}, Description: Microsoft ISATAP Adapter, Interface Type: Tunnel, Operational Status: Down;
Unicast IPAddresses: fe80::5efe:10.0.5.60%12;
Network Interface, Name: Teredo Tunneling Pseudo-Interface, Description: Teredo Tunneling Pseudo-Interface, Interface Type: Tunnel, Operational Status: Up;
Unicast IPAddresses: 2001:0:4137:9e76:3c48:1248:f5ff:fac3; fe80::3c48:1248:f5ff:fac3%13;
[13.01.2011 21:11:27] <01> Info Starting job mode: 'Normal'
[13.01.2011 21:11:27] <01> Info Job state 'Working'
[13.01.2011 21:11:27] <01> Info -------------------------------------------------------------------------------------
[13.01.2011 21:11:27] <01> Info Job ID: '539e1a8d-1b57-4e8d-8dab-a64e004c83d2'
[13.01.2011 21:11:27] <01> Info Job Name: 'ExchangeRD120'
[13.01.2011 21:11:27] <01> Info Job Mode: 'Normal'
[13.01.2011 21:11:27] <01> Info Job Type: 'VDDK Backup'
[13.01.2011 21:11:27] <01> Info Job Options: 'RunManually: [True], Compression: [6], Storage block size: [KbBlockSize1024], VcbMode: [san], VDDKMode: [nbd], UseClassicBackup: [False]EnableIntegrityChecks: [True]RetainCycles: [14], Algorithm: [Increment], TransformFullToSyntethic: [True], TransformToSyntethicDays: [System.DayOfWeek[]], TransformIncrementsToSyntethic: [False], EnableInitialPass: [False], EmailNotification: [True], EmailNotificationAddresses: [], SnmpNotification: [False], VmToolsQuiesce: [False], DiskFilter: [2000;2001;2002;2003;2004;2005;2006;2008;2009;2010;2011;2012;2013;2014;2015;2016;2017;2018;2019;2020;2021;2022;2024;2025;2026;2027;2028;2029;2030;2031;2032;2033;2034;2035;2036;2037;2038;2040;2041;2042;2043;2044;2045;2046;2047;2048;2049;2050;2051;2052;2053;2054;2056;2057;2058;2059;2060;2061;2062;2063]Backup VM templates: [True], Exclude VM templates from incremental: [True]Replica name suffix: [], Datastore: [], Datastore ref: []EncryptLanTraffic: [False]EnableFullBackup: [False]FullBackupScheduleKind: [Daily]FullBackupDays: [ Saturday ]'
[13.01.2011 21:11:27] <01> Info Job VSS Settings: [<?xml version="1.0" encoding="utf-16"?><CVssOptions xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance" xmlns:xsd="http://www.w3.org/2001/XMLSchema"><Enabled>true</Enabled><IgnoreErrors>false</IgnoreErrors><Credentials><UserName>sfyit\administrator</UserName><Password>AQAAANCMnd8BFdERjHoAwE/Cl+sBAAAAS6GXUZKh6EKOThstj+meAwQAAAACAAAAAAAQZgAAAAEAACAAAABgwIKyNHtgy0XJLbzaTLenFc5gldsi35GaRV2eNdvtGQAAAAAOgAAAAAIAACAAAAB8EI61sw2fw7F9djoHKOuBKv3h/hrKT7Kavf490hVuNRAAAACWPyBM3Xbe/M1iS0XqjswHQAAAAIKr4HAlsWOXs88cDpfkQjtOvGfAmiphaX5yZFIu+F2L3Kw64vWM3ejvu2zlS/LsIkawOFl0uvVuaPqGZo7Pcos=</Password></Credentials><IncludedIndexingFolders /><ExcludedIndexingFolders><string>%windir%</string><string>%ProgramFiles%</string><string>%TEMP%</string></ExcludedIndexingFolders><TransactionLogsTruncation>OnlyOnSuccessJob</TransactionLogsTruncation></CVssOptions>]
[13.01.2011 21:11:27] <01> Info Job ScheduleOptions: [Start time: [1/13/2011 10:00:00 PM], Latest run time: [1/13/2011 9:11:16 PM], Next run time: [], Retry times on failure: [3], Retry timeout: [10 min], Daily options: [Enabled: True, DayNumberInMonth: Everyday, Days: Sunday, Monday, Tuesday, Wednesday, Thursday, Friday, Saturday]Monthly options: [Enabled: False, Time: 1/13/2011 10:00:00 PM, Day Number In Month: Fourth, Day Of Week: Saturday, Months: January, February, March, April, May, June, July, August, September, October, November, December]Periodically options: [Enabled: False, Period: 1 hour(s), ScheduleString: <?xml version="1.0"?><scheduler><Sunday>0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0</Sunday><Monday>0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0</Monday><Tuesday>0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0</Tuesday><Wednesday>0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0</Wednesday><Thursday>0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0</Thursday><Friday>0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0</Friday><Saturday>0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0,0</Saturday></scheduler>]Continuous options: [Enabled: False]]
[13.01.2011 21:11:27] <01> Info Object In Job: [Id: [566e917e-b705-49f6-9b2b-6b5730b7f56b], ObjectId: [2003baf0-cff8-4469-a6fc-1670d18e06a5], JobId: [539e1a8d-1b57-4e8d-8dab-a64e004c83d2]FolderId: [00000000-0000-0000-0000-000000000000]\nLocation: [10.0.5.10\Windows2008x64-.11-.12-(Exchange)], Type: [Include], ApproxSize: [105227800652]\nVssOptions: [<?xml version="1.0" encoding="utf-16"?><CVssOptions xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance" xmlns:xsd="http://www.w3.org/2001/XMLSchema"><Enabled>true</Enabled><IgnoreErrors>false</IgnoreErrors><GuestFSIndexingType>ExceptSpecifiedFolders</GuestFSIndexingType><IncludedIndexingFolders /><ExcludedIndexingFolders><string>%windir%</string><string>%ProgramFiles%</string><string>%TEMP%</string></ExcludedIndexingFolders><TransactionLogsTruncation>OnlyOnSuccessJob</TransactionLogsTruncation></CVssOptions>], \nPlatform: [EVmware], UpdateVmx: [False]\nDiskFilter: [2000;2001;2002;2003;2004;2005;2006;2008;2009;2010;2011;2012;2013;2014;2015;2016;2017;2018;2019;2020;2021;2022;2024;2025;2026;2027;2028;2029;2030;2031;2032;2033;2034;2035;2036;2037;2038;2040;2041;2042;2043;2044;2045;2046;2047;2048;2049;2050;2051;2052;2053;2054;2056;2057;2058;2059;2060;2061;2062;2063], ]
[13.01.2011 21:11:27] <01> Info Job operation 'Building VMs list'
[13.01.2011 21:11:27] <01> Info Last point was not found.
[13.01.2011 21:11:27] <01> Info Got 0 excluded objects
[13.01.2011 21:11:27] <01> Info Got 1 included objects
[13.01.2011 21:11:27] <01> Info [Soap] Outgoing connection '10.0.5.10:443:root:False::0:1'.
[13.01.2011 21:11:27] <01> Info [Soap] Creating new connection '10.0.5.10:443:root:False::0:1'.
[13.01.2011 21:11:28] <01> Info [Soap] Logging on to "10.0.5.10", port 443, user "root", proxy srv: port:0, serviceType: public, timeout: 200000 ms
[13.01.2011 21:11:49] <01> Info [Soap] Host content info: host "10.0.5.10", type "embeddedEsx", version "4.0.0", build "164009", apiVersion "4.0", hostTime "1/14/2011 5:07:40 AM"
[13.01.2011 21:11:49] <01> Info Updating information for the host"10.0.5.10"
[13.01.2011 21:12:04] <01> Info [Soap] Loading 'ha-folder-root:Folder' hierarchy
[13.01.2011 21:12:07] <01> Info [Soap] Loaded 22 hierarchy objects from "10.0.5.10", 1 Datacenter(s), 1 HostSystem(s), 13 VirtualMachine(s), 2 Datastore(s), 1 ResourcePool(s).
[13.01.2011 21:12:07] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is disposing.
[13.01.2011 21:12:07] <01> Info Getting child VMs for object Object, id: 2003baf0-cff8-4469-a6fc-1670d18e06a5, name: Windows2008x64-.11-.12-(Exchange), type: VM, vi type: VirtualMachine, host name: 10.0.5.10.
[13.01.2011 21:12:07] <01> Info VM name: Windows2008x64-.11-.12-(Exchange), VM ref: 16, VM host name: ESX4.sfyit.local, source host name: 10.0.5.10, source host id : 565e317d-73fe-448c-a992-705a7c6f98cc, source host is VC: False
[13.01.2011 21:12:07] <01> Info Got 1 processing objects
[13.01.2011 21:12:07] <01> Info Got "0" VSS child objects. Sorting them.
[13.01.2011 21:12:07] <01> Info Loading their content.
[13.01.2011 21:12:07] <01> Info Getting child VMs for the object Object, id: 2003baf0-cff8-4469-a6fc-1670d18e06a5, name: Windows2008x64-.11-.12-(Exchange), type: VM, vi type: VirtualMachine, host name: 10.0.5.10.
[13.01.2011 21:12:07] <01> Info VM name: Windows2008x64-.11-.12-(Exchange), VM ref: 16, VM host name: ESX4.sfyit.local, source host name: 10.0.5.10, source host id : 565e317d-73fe-448c-a992-705a7c6f98cc, source host is VC: False
[13.01.2011 21:12:07] <01> Info Got "0" exclude disks child objects. Sorting them.
[13.01.2011 21:12:07] <01> Info Loading their content.
[13.01.2011 21:12:07] <01> Info Getting child VMs for the object Object, id: 2003baf0-cff8-4469-a6fc-1670d18e06a5, name: Windows2008x64-.11-.12-(Exchange), type: VM, vi type: VirtualMachine, host name: 10.0.5.10.
[13.01.2011 21:12:07] <01> Info VM name: Windows2008x64-.11-.12-(Exchange), VM ref: 16, VM host name: ESX4.sfyit.local, source host name: 10.0.5.10, source host id : 565e317d-73fe-448c-a992-705a7c6f98cc, source host is VC: False
[13.01.2011 21:12:07] <01> Info VM task, VM name: 'Windows2008x64-.11-.12-(Exchange)', VM host name: 'ESX4.sfyit.local', VM host info: 'VMware ESXi 4.0.0 build-164009', VM host apiVersion: '4.0', source host name: '10.0.5.10', source host id: '565e317d-73fe-448c-a992-705a7c6f98cc', source host type: 'ESXi', size: '128849018880'
[13.01.2011 21:12:07] <01> Info VSS options derived from "Object, id: 2003baf0-cff8-4469-a6fc-1670d18e06a5, name: Windows2008x64-.11-.12-(Exchange), type: VM, vi type: VirtualMachine, host name: 10.0.5.10", disk exclusion: "Object, id: 2003baf0-cff8-4469-a6fc-1670d18e06a5, name: Windows2008x64-.11-.12-(Exchange), type: VM, vi type: VirtualMachine, host name: 10.0.5.10".
[13.01.2011 21:12:07] <01> Info Job totalObjects '1', totalSize '120.00 GB'
[13.01.2011 21:12:07] <01> Info [Soap] Outgoing connection '10.0.5.10:443:root:False::0:1'.
[13.01.2011 21:12:07] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is provided from the cache.
[13.01.2011 21:12:07] <01> Info Updating information for the host"10.0.5.10"
[13.01.2011 21:12:08] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is disposing.
[13.01.2011 21:12:08] <01> Info Target host "My Computer", protocol "Local"
[13.01.2011 21:12:08] <01> Info Creating file commander for the host 'My Computer', protocol 'Local'
[13.01.2011 21:12:08] <01> Info [AP] Starting client agent on the 'localhost'
[13.01.2011 21:12:08] <01> Info [AP] Local agent started, pid 3524, args -lflush,"C:\Users\Administrator\AppData\Local\Veeam\Backup\VeeamAgent_ExchangeRD120_cli.log" -i716f69fd-1bbc-4498-91a2-ede581e02ca7
[13.01.2011 21:12:08] <12> Info [AP] (Client) output: LOG:C:\Users\Administrator\AppData\Local\Veeam\Backup\VeeamAgent_ExchangeRD120_cli.log\n
[13.01.2011 21:12:09] <09> Info [AP] (Client) state: ready
[13.01.2011 21:12:09] <09> Info [AP] (Client) output: PID: 3524\n
[13.01.2011 21:12:09] <09> Info [AP] (Client) output: >\n
[13.01.2011 21:12:10] <01> Info [Point] Finding last point in backup 'fe4c3874-6347-47ee-8081-8e6f69704e13'
[13.01.2011 21:12:10] <01> Info [Point] Last point in backup 'fe4c3874-6347-47ee-8081-8e6f69704e13' not found
[13.01.2011 21:12:10] <01> Info Preparing point in full mode
[13.01.2011 21:12:10] <01> Info [Point] Getting last num in backup 'fe4c3874-6347-47ee-8081-8e6f69704e13'
[13.01.2011 21:12:10] <01> Info [Point] Last point in backup 'fe4c3874-6347-47ee-8081-8e6f69704e13' is not found
[13.01.2011 21:12:10] <01> Info [Point] Create, id '6d7ab3b1-24c0-4761-9710-824d9ba2bc09', link_id '00000000-0000-0000-0000-000000000000', num '1', creation_time '1/13/2011 9:12:10 PM', type 'Basic', alg 'Full', group_id '4aee3766-e141-4cac-bbc4-a4fc7b85f6fd', backup_id 'fe4c3874-6347-47ee-8081-8e6f69704e13'
[13.01.2011 21:12:10] <01> Info Deleting empty storages from backup 'fe4c3874-6347-47ee-8081-8e6f69704e13'
[13.01.2011 21:12:10] <01> Info Preparing storages in full mode
[13.01.2011 21:12:10] <01> Info [Storage] Creating storage, id 'dc0f0d62-d353-462b-bbce-16f0a803cc5c', hostId '6745a759-2205-4cd2-b172-8ec8f7e60ef8', filePath '\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk'
[13.01.2011 21:12:11] <01> Info [Local] Check existing '\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10'
[13.01.2011 21:12:11] <01> Info Prepairing storage '\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk' for write
[13.01.2011 21:12:11] <01> Info [AP] Agent command: "prepStorageForWriteEx\n\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk\n1024\n"
[13.01.2011 21:12:13] <09> Info [AP] (Client) output: >\n
[13.01.2011 21:12:13] <01> Info Locking storage as write-only, storageId: 'dc0f0d62-d353-462b-bbce-16f0a803cc5c'
[13.01.2011 21:12:14] <01> Info Locking storage(s) as Write
[13.01.2011 21:12:14] <01> Info [LockResolver] Getting conflicting sessions
[13.01.2011 21:12:14] <01> Info Storage has been locked, lockId: '5709dd8e-a9ac-4f0a-8c24-0eab0484a0ca'
[13.01.2011 21:12:14] <01> Info LockLeaseKeepAliveer 2: Created, ttl 300sec
[13.01.2011 21:12:14] <01> Info [Storage] Checking storage 'My Computer:\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk:dc0f0d62-d353-462b-bbce-16f0a803cc5c'. Storage version '1', current supported version '1'
[13.01.2011 21:12:14] <01> Info Checking the existence of the storage '\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk'
[13.01.2011 21:12:14] <01> Info [Local] Check existing '\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk'
[13.01.2011 21:12:14] <01> Info Prepairing storage '\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk' for write
[13.01.2011 21:12:14] <01> Info [AP] Agent command: "prepStorageForWriteEx\n\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk\n1024\n"
[13.01.2011 21:12:15] <09> Info [AP] (Client) output: >\n
[13.01.2011 21:12:16] <01> Info Checking backup file '\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk' consistency (level 'Light')
[13.01.2011 21:12:16] <01> Info [AP] Agent command: "version\n\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk\n"
[13.01.2011 21:12:16] <09> Info [AP] (Client) output: 5\n
[13.01.2011 21:12:16] <09> Info [AP] (Client) output: >\n
[13.01.2011 21:12:16] <01> Info [AP] Agent command: "checkStg\n\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk\n1\n"
[13.01.2011 21:12:19] <09> Info [AP] (Client) output: 100\n
[13.01.2011 21:12:19] <09> Info [AP] (Client) output: Errors: 0\n
[13.01.2011 21:12:19] <09> Info [AP] (Client) output: >\n
[13.01.2011 21:12:19] <01> Info Waiting for the next backup task.
[13.01.2011 21:12:19] <01> Info Job operation 'Processing object 'Windows2008x64-.11-.12-(Exchange)''
[13.01.2011 21:12:19] <01> Info ------------------------------------------------------------------
[13.01.2011 21:12:19] <01> Info Source object 'Windows2008x64-.11-.12-(Exchange)', source host '10.0.5.10', target host 'My Computer', target dir '\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10', target file 'ExchangeRD120'
[13.01.2011 21:12:19] <01> Info [Soap] Outgoing connection '10.0.5.10:443:root:False::0:1'.
[13.01.2011 21:12:19] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is provided from the cache.
[13.01.2011 21:12:19] <01> Info Updating information for the host"10.0.5.10"
[13.01.2011 21:12:20] <01> Info [VimApi] LogUserEvent, ref 16, type VirtualMachine, message "Source: Veeam Backup\nAction: Job "ExchangeRD120"\nOperation: Started\nStatus: Success\nID: 88f9df4e-7d8c-4397-92f1-38175458b16c\nDescription: "
[13.01.2011 21:12:20] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is disposing.
[13.01.2011 21:12:20] <01> Info Task operation: 'Validating task'
[13.01.2011 21:12:20] <01> Info [Soap] Outgoing connection '10.0.5.10:443:root:False::0:1'.
[13.01.2011 21:12:20] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is provided from the cache.
[13.01.2011 21:12:20] <01> Info Updating information for the host"10.0.5.10"
[13.01.2011 21:12:21] <01> Info [Soap] Loading '16:VirtualMachine' hierarchy
[13.01.2011 21:12:22] <01> Info [Soap] Loaded 5 hierarchy objects from "10.0.5.10", 0 Datacenter(s), 1 HostSystem(s), 1 VirtualMachine(s), 2 Datastore(s), 0 ResourcePool(s).
[13.01.2011 21:12:22] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is disposing.
[13.01.2011 21:12:22] <01> Info VM information: name "Windows2008x64-.11-.12-(Exchange)", ref "16", uuid "564d1be6-477b-df53-070a-2a4686796ff2", host "ESX4.sfyit.local", resourcePool "ha-root-pool", connectionState "Connected", powerState "PoweredOn", template "False", changeTracking "True", configVersion "vmx-07"
[13.01.2011 21:12:22] <01> Info VMX file: "[datastore1] Windows2008x64/Windows2008x64.vmx"
[13.01.2011 21:12:22] <01> Info Config file: "[datastore1] Windows2008x64/Windows2008x64.vmsd"
[13.01.2011 21:12:22] <01> Info Config file: "[datastore1] Windows2008x64/Windows2008x64-aux.xml"
[13.01.2011 21:12:22] <01> Info Config file: "[datastore1] Windows2008x64/Windows2008x64.nvram"
[13.01.2011 21:12:22] <01> Info Config file: "[datastore1] Windows2008x64/Windows2008x64.vmxf"
[13.01.2011 21:12:22] <01> Info Log file: "[datastore1] Windows2008x64/vmware-23.log"
[13.01.2011 21:12:22] <01> Info Log file: "[datastore1] Windows2008x64/vmware-19.log"
[13.01.2011 21:12:22] <01> Info Log file: "[datastore1] Windows2008x64/vmware-20.log"
[13.01.2011 21:12:22] <01> Info Log file: "[datastore1] Windows2008x64/vmware-21.log"
[13.01.2011 21:12:22] <01> Info Log file: "[datastore1] Windows2008x64/vmware.log"
[13.01.2011 21:12:22] <01> Info Log file: "[datastore1] Windows2008x64/vmware-22.log"
[13.01.2011 21:12:22] <01> Info Log file: "[datastore1] Windows2008x64/vmware-24.log"
[13.01.2011 21:12:22] <01> Info Disk: label "Hard disk 1", path "[datastore1] Windows2008x64/Windows2008x64.vmdk", capacity 50.00 GB, backing "CFlatVirtualDiskV2", mode "persistent", thinProvisioned "False"
[13.01.2011 21:12:22] <01> Info Disk: label "Hard disk 2", path "[datastore1] Windows2008x64/Windows2008x64_2.vmdk", capacity 70.00 GB, backing "CFlatVirtualDiskV2", mode "persistent", thinProvisioned "False"
[13.01.2011 21:12:22] <01> Info Target: Backup, Mode: Normal
[13.01.2011 21:12:22] <01> Info [AP] Starting client agent on the 'localhost'
[13.01.2011 21:12:22] <01> Info [AP] Local agent started, pid 4584, args -lflush,"C:\Users\Administrator\AppData\Local\Veeam\Backup\VeeamAgent_ExchangeRD120_cli.log" -i3703b161-1209-40a3-a917-0aafea2780ae
[13.01.2011 21:12:22] <04> Info [AP] (Client) output: LOG:C:\Users\Administrator\AppData\Local\Veeam\Backup\VeeamAgent_ExchangeRD120_cli.1.log\n
[13.01.2011 21:12:26] <13> Info [AP] (Client) state: ready
[13.01.2011 21:12:26] <13> Info [AP] (Client) output: PID: 4584\n
[13.01.2011 21:12:26] <13> Info [AP] (Client) output: >\n
[13.01.2011 21:12:26] <01> Info Task operation: 'Checking the license for the source host 'ESX4.sfyit.local''
[13.01.2011 21:12:26] <01> Info [Soap] Outgoing connection '10.0.5.10:443:root:False::0:1'.
[13.01.2011 21:12:26] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is provided from the cache.
[13.01.2011 21:12:26] <01> Info Updating information for the host"10.0.5.10"
[13.01.2011 21:12:27] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is disposing.
[13.01.2011 21:12:27] <01> Info Source: VDDK
[13.01.2011 21:12:27] <01> Info [VddkSource] Vddk current mode is: nbd
[13.01.2011 21:12:29] <01> Info [Soap] Outgoing connection '10.0.5.10:443:root:False::0:1'.
[13.01.2011 21:12:29] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is provided from the cache.
[13.01.2011 21:12:29] <01> Info Updating information for the host"10.0.5.10"
[13.01.2011 21:12:29] <01> Info [Soap] Outgoing connection '10.0.5.10:443:root:False::0:1'.
[13.01.2011 21:12:29] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is provided from the cache.
[13.01.2011 21:12:29] <01> Info Updating information for the host"10.0.5.10"
[13.01.2011 21:12:30] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is disposing.
[13.01.2011 21:12:30] <01> Info Task operation: 'Starting VM backup process'
[13.01.2011 21:12:30] <01> Info Task operation: 'Initializing target session'
[13.01.2011 21:12:30] <01> Info Retrieving host 'localhost' drives info
[13.01.2011 21:12:31] <01> Info Drive 'C:\', type 'Fixed', volume label '', file system 'NTFS', total space 39.90 GB, free space 26.43 GB, free space to current user 26.43 GB
[13.01.2011 21:12:31] <01> Info Drive 'E:\', type 'Fixed', volume label 'QNAP VEEAM', file system 'NTFS', total space 399.87 GB, free space 384.21 GB, free space to current user 384.21 GB
[13.01.2011 21:12:31] <01> Info Drive 'G:\', type 'Fixed', volume label 'TEST-DELME', file system 'NTFS', total space 1,021.00 MB, free space 988.13 MB, free space to current user 988.13 MB
[13.01.2011 21:12:31] <01> Info Preparing oib in full mode
[13.01.2011 21:12:31] <01> Info [OIB] Finding oib for object '2003baf0-cff8-4469-a6fc-1670d18e06a5' in point: '6d7ab3b1-24c0-4761-9710-824d9ba2bc09'
[13.01.2011 21:12:32] <01> Info [OIB] Oib is not found
[13.01.2011 21:12:32] <01> Info [Oib] Create, id 'a36bead6-2860-4e8d-b1e0-01fd63f96555', object_id '2003baf0-cff8-4469-a6fc-1670d18e06a5', point_id '6d7ab3b1-24c0-4761-9710-824d9ba2bc09', storage_id 'dc0f0d62-d353-462b-bbce-16f0a803cc5c', link_id '00000000-0000-0000-0000-000000000000', is_corrupted 'True', is_consistent 'True', state 'Nothing', type 'Full', alg 'Full'
[13.01.2011 21:12:32] <01> Info Saving summary into "\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk", insidePath "565e317d-73fe-448c-a992-705a7c6f98cc (16)"
[13.01.2011 21:12:32] <01> Info [AP] Agent command: "text2tar\nveeamfs:0:565e317d-73fe-448c-a992-705a7c6f98cc (16)/summary.xml@\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk\n<OibSummary><Backup Id="fe4c3874-6347-47ee-8081-8e6f69704e13" JobId="539e1a8d-1b57-4e8d-8dab-a64e004c83d2" JobName="ExchangeRD120" JobSourceType="2" JobTargetType="0" JobTargetHostId="6745a759-2205-4cd2-b172-8ec8f7e60ef8" JobTargetHostProtocol="3" /><Point Id="6d7ab3b1-24c0-4761-9710-824d9ba2bc09" LinkId="00000000-0000-0000-0000-000000000000" Num="1" GroupId="4aee3766-e141-4cac-bbc4-a4fc7b85f6fd" CreationTime="01/13/2011 21:12:10" Algoritm="0" Type="0" BackupId="fe4c3874-6347-47ee-8081-8e6f69704e13" /><Storage Id="dc0f0d62-d353-462b-bbce-16f0a803cc5c" BackupId="fe4c3874-6347-47ee-8081-8e6f69704e13" HostId="6745a759-2205-4cd2-b172-8ec8f7e60ef8" FilePath="\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk" Version="1" CreationTime="01/13/2011 21:12:10" ModificationTime="01/13/2011 21:12:10" BlockSize="KbBlockSize1024"><?xml version="1.0" encoding="utf-16"?><CBackupStats xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance" xmlns:xsd="http://www.w3.org/2001/XMLSchema" /></Storage><OIB Id="a36bead6-2860-4e8d-b1e0-01fd63f96555" ObjectId="2003baf0-cff8-4469-a6fc-1670d18e06a5" PointId="6d7ab3b1-24c0-4761-9710-824d9ba2bc09" StorageId="dc0f0d62-d353-462b-bbce-16f0a803cc5c" LinkId="00000000-0000-0000-0000-000000000000" IsCorrupted="True" IsConsistent="True" State="0" Type="0" Algorithm="0" InsideDir="565e317d-73fe-448c-a992-705a7c6f98cc (16)" CreationTime="01/13/2011 21:12:32" VmName="Windows2008x64-.11-.12-(Exchange)" ApproxSize="128849018880" ProcessId="-1" EffectiveMemoryMb="8192" HasIndex="False" AuxData="<?xml version="1.0" encoding="utf-16"?><COibAuxDataVmware xmlns:xsi="http://www.w3.org/2001/XMLSchema-instance" xmlns:xsd="http://www.w3.org/2001/XMLSchema"><HostName>10.0.5.10</HostName><DataStoreRef>4a88160f-a2855238-84ec-00215e534b2a</DataStoreRef><ResourcePoolRef>ha-root-pool</ResourcePoolRef></COibAuxDataVmware>"><GuestInfo><Property Name="GuestOsName"><Value /></Property><Property Name="Ip"><Value /></Property><Property Name="DnsName"><Value /></Property><Property Name="ToolsStatus"><Value>Ok</Value></Property><Property Name="ToolsVersionStatus"><Value>NotInstalled</Value></Property></GuestInfo></OIB><Object Id="2003baf0-cff8-4469-a6fc-1670d18e06a5" Type="1" HostId="565e317d-73fe-448c-a992-705a7c6f98cc" Name="Windows2008x64-.11-.12-(Exchange)" ObjectId="16" ViType="VirtualMachine" Path="10.0.5.10\Windows2008x64-.11-.12-(Exchange)"><GuestInfo><Property Name="GuestOsName"><Value /></Property><Property Name="Ip"><Value /></Property><Property Name="DnsName"><Value /></Property><Property Name="ToolsStatus"><Value>Ok</Value></Property><Property Name="ToolsVersionStatus"><Value>NotInstalled</Value></Property></GuestInfo></Object><TargetHost Id="6745a759-2205-4cd2-b172-8ec8f7e60ef8" Name="My Computer" Description="" Ip="" Type="3" Reference="" Info="" ParentId="00000000-0000-0000-0000-000000000000" Protocol="0" ApiVersion="0" WinCreds="" /><PrevFileName></PrevFileName><OibFiles /><SourceHost Id="565e317d-73fe-448c-a992-705a7c6f98cc" Name="10.0.5.10" Description="" Ip="0.0.0.0" Type="6" Reference="ha-host" Info="VMware ESXi 4.0.0 build-164009" ParentId="00000000-0000-0000-0000-000000000000" Protocol="0" ApiVersion="4" WinCreds="" /></OibSummary>\n.\n"
[13.01.2011 21:12:36] <13> Info [AP] (Client) output: >\n
[13.01.2011 21:12:36] <01> Info [AP] Starting server agent on the 'localhost', startPort '2500', endPort '2600'
[13.01.2011 21:12:36] <01> Info [AP] Local agent started, pid 4968, args -s2500-2600 -u8318c968-41a4-4714-9123-2965134f9515 -p49a8b161-75ad-40cd-a379-ad6a80e58cef -lflush,"C:\Users\Administrator\AppData\Local\Veeam\Backup\VeeamAgent_ExchangeRD120_srv.log" -i7649b916-8de1-4815-b516-e80f036e7d08
[13.01.2011 21:12:37] <16> Info [AP] (Server) output: LOG:C:\Users\Administrator\AppData\Local\Veeam\Backup\VeeamAgent_ExchangeRD120_srv.log\n
[13.01.2011 21:12:37] <16> Info [AP] (Server) output: PID: 4968\n
[13.01.2011 21:12:37] <16> Info [AP] (Server) output: Listening port:2502\n
[13.01.2011 21:12:42] <17> Info [AP] (Server) state: ready
[13.01.2011 21:12:43] <01> Info [AP] Disconnecting
[13.01.2011 21:12:49] <18> Info [AP] (Client) output: >\n
[13.01.2011 21:12:49] <01> Info [AP] Connecting to "sfy-veeam01", port 2502, user"8318c968-41a4-4714-9123-2965134f9515"
[13.01.2011 21:12:49] <18> Info [AP] (Client) output: >\n
[13.01.2011 21:12:50] <01> Info [AP] Agent command: "viSoapCreds\n10.0.5.10\n10.0.5.10\n443\nroot\n******\n"
[13.01.2011 21:12:50] <18> Info [AP] (Client) output: >\n
[13.01.2011 21:12:50] <01> Info [Soap] Outgoing connection '10.0.5.10:443:root:False::0:1'.
[13.01.2011 21:12:50] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is provided from the cache.
[13.01.2011 21:12:50] <01> Info Updating information for the host"10.0.5.10"
[13.01.2011 21:12:51] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is disposing.
[13.01.2011 21:12:51] <01> Info [AP] Starting client agent on the 'localhost'
[13.01.2011 21:12:51] <01> Info [AP] Local agent started, pid 848, args -lflush,"C:\Users\Administrator\AppData\Local\Veeam\Backup\VeeamAgent_cli.log" -i6401a2a3-0e5a-4a60-a126-897756368b87
[13.01.2011 21:12:57] <19> Info [AP] (Client) output: LOG:C:\Users\Administrator\AppData\Local\Veeam\Backup\VeeamAgent_cli.1.log\n
[13.01.2011 21:12:57] <19> Info [AP] (Client) output: PID: 848\n
[13.01.2011 21:12:57] <19> Info [AP] (Client) output: >\n
[13.01.2011 21:13:06] <15> Info [AP] (Client) state: ready
[13.01.2011 21:13:06] <01> Info [AP] Starting server agent on the 'localhost', startPort '2500', endPort '2600'
[13.01.2011 21:13:06] <01> Info [AP] Local agent started, pid 4260, args -s2500-2600 -u09a05888-1de9-496d-86d9-96b7980d0875 -p03c2034e-f09d-4d7d-ab13-97fe717ed7a0 -lflush,"C:\Users\Administrator\AppData\Local\Veeam\Backup\VeeamAgent_srv.log" -ife141345-3679-4f39-bbbe-9345787dae15
[13.01.2011 21:13:15] <20> Info [AP] (Server) output: LOG:C:\Users\Administrator\AppData\Local\Veeam\Backup\VeeamAgent_srv.1.log\n
[13.01.2011 21:13:15] <20> Info [AP] (Server) output: PID: 4260\n
[13.01.2011 21:13:15] <20> Info [AP] (Server) output: Listening port:2503\n
[13.01.2011 21:13:23] <21> Info [AP] (Server) state: ready
[13.01.2011 21:13:23] <01> Info [AP] Connecting to "sfy-veeam01", port 2503, user"09a05888-1de9-496d-86d9-96b7980d0875"
[13.01.2011 21:13:35] <22> Info [AP] (Client) output: >\n
[13.01.2011 21:13:35] <01> Info [AP] Agent command: "viSoapCreds\n10.0.5.10\n10.0.5.10\n443\nroot\n******\n"
[13.01.2011 21:13:35] <22> Info [AP] (Client) output: >\n
[13.01.2011 21:13:35] <01> Info [AP] Agent command: "file2text\nnfc://conn:10.0.5.10,nfchost:ha-host,stg:4a88160f-a2855238-84ec-00215e534b2a@Windows2008x64/Windows2008x64.vmx\n16384\n"
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: .encoding = "UTF-8"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: config.version = "8"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: virtualHW.version = "7"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge0.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge4.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge4.virtualDev = "pcieRootPort"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge4.functions = "8"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge5.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge5.virtualDev = "pcieRootPort"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge5.functions = "8"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge6.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge6.virtualDev = "pcieRootPort"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge6.functions = "8"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge7.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge7.virtualDev = "pcieRootPort"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge7.functions = "8"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: vmci0.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: nvram = "Windows2008x64.nvram"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: deploymentPlatform = "windows"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: virtualHW.productCompatibility = "hosted"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: unity.customColor = "|23C0C0C0"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: tools.upgrade.policy = "useGlobal"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: powerType.powerOff = "soft"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: powerType.powerOn = "default"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: powerType.suspend = "hard"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: powerType.reset = "soft"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: displayName = "Windows2008x64-.11-.12-(Exchange)"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: extendedConfigFile = "Windows2008x64.vmxf"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: floppy0.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: numvcpus = "2"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0.sharedBus = "none"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0.virtualDev = "lsisas1068"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: memsize = "8192"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0:0.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0:0.fileName = "Windows2008x64.vmdk"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0:0.deviceType = "scsi-hardDisk"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ide1:0.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ide1:0.clientDevice = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ide1:0.deviceType = "atapi-cdrom"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ide1:0.startConnected = "FALSE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: floppy0.startConnected = "FALSE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: floppy0.clientDevice = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet0.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet0.virtualDev = "e1000"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet0.networkName = "VM Network"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet0.addressType = "generated"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: guestOSAltName = "Microsoft Windows Server 2008 (64-bit)"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: guestOS = "longhorn-64"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: uuid.location = "56 4d 1b e6 47 7b df 53-07 0a 2a 46 86 79 6f f2"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: uuid.bios = "56 4d 1b e6 47 7b df 53-07 0a 2a 46 86 79 6f f2"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: vc.uuid = "52 b6 fc 5b 2c 19 cd ef-77 12 7b 11 2c 4a da 5c"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ide1:0.fileName = "/usr/lib/vmware/isoimages/windows.iso"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: floppy0.fileName = "/dev/fd0"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet0.generatedAddress = "00:0c:29:79:6f:f2"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: tools.syncTime = "FALSE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: cleanShutdown = "FALSE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: replay.supported = "FALSE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: sched.swap.derivedName = "/vmfs/volumes/4a88160f-a2855238-84ec-00215e534b2a/Windows2008x64/Windows2008x64-7cc2c9fc.vswp"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0:0.redo = ""\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: vmotion.checkpointFBSize = "4194304"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge0.pciSlotNumber = "17"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge4.pciSlotNumber = "21"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge5.pciSlotNumber = "22"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge6.pciSlotNumber = "23"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: pciBridge7.pciSlotNumber = "24"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0.pciSlotNumber = "160"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet0.pciSlotNumber = "32"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: vmci0.pciSlotNumber = "33"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0.sasWWID = "50 05 05 66 47 7b df 50"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet0.generatedAddressOffset = "0"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: vmci0.id = "-2038861837"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: hostCPUID.0 = "0000000a756e65476c65746e49656e69"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: guestCPUID.0 = "0000000a756e65476c65746e49656e69"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: userCPUID.0 = "0000000a756e65476c65746e49656e69"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: hostCPUID.1 = "0001067600040800000ce3bdbfebfbff"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: guestCPUID.1 = "0001067600010800800822010febfbff"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: userCPUID.1 = "0001067600040800000822010febfbff"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: hostCPUID.80000001 = "00000000000000000000000120000800"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: guestCPUID.80000001 = "00000000000000000000000120000800"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: userCPUID.80000001 = "00000000000000000000000120000800"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: evcCompatibilityMode = "FALSE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0:1.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0:1.fileName = "Windows2008x64_2.vmdk"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0:1.deviceType = "scsi-hardDisk"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0:1.redo = ""\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: sched.scsi0:1.shares = "normal"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: tools.remindInstall = "FALSE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: migrate.hostlog = "./Windows2008x64-7cc2c9fc.hlog"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet1.virtualDev = "e1000"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet1.pciSlotNumber = "34"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet1.startConnected = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet1.allowGuestConnectionControl = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet1.features = "1"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet1.wakeOnPcktRcv = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet1.networkName = "VM Network"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet1.present = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet1.addressType = "generated"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet1.generatedAddress = "00:0c:29:79:6f:fc"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ethernet1.generatedAddressOffset = "10"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: annotation = "vRanger Pro Backup: Type [Incremental] Result [Success] Time [1/12/2011 9:04:34 PM] Repository [QNAP-NAS]|0A"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0:0.ctkEnabled = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: scsi0:1.ctkEnabled = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: ctkEnabled = "TRUE"\n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: \n
[13.01.2011 21:13:38] <22> Info [AP] (Client) output: >\n
[13.01.2011 21:13:39] <01> Info Task operation: 'Checking free space on source datastore'
[13.01.2011 21:13:39] <01> Info Task operation: 'Creating snapshot'
[13.01.2011 21:13:39] <01> Info Task operation: 'Validating guest agent availability for the VM'
[13.01.2011 21:13:39] <01> Info Task operation: 'Starting guest agent'
[13.01.2011 21:13:39] <01> Info [VssGAConn] Initializing VSS guest agent connection
[1/13/2011 9:13:40 PM]Info ==================================================================================
[1/13/2011 9:13:40 PM]Info Guest agent control version info
[1/13/2011 9:13:40 PM]Info {
[1/13/2011 9:13:40 PM]Info Module name: [VeeamGuestAgentControl.exe].
[1/13/2011 9:13:40 PM]Info Module path: [C:\Program Files\Veeam\Backup and Replication\VSS\VeeamGuestAgentControl.exe].
[1/13/2011 9:13:40 PM]Info Module version: [5.0.1.198].
[1/13/2011 9:13:40 PM]Info }
[13.01.2011 21:13:40] <01> Error [VssGAConn] Failed to connect. IP address not found. at Veeam.Backup.VssProvider.CVssGAConnection.ConnectViaRpc(IVeeamGAConnection connection, String[] ipAddresses, CCredentials vmCreds)
[13.01.2011 21:13:40] <01> Error at Veeam.Backup.VssProvider.CVssGAConnection.CreateEx(String hostIp, UInt16 hostPort, String hostUser, String hostPass, String vmVmx, String[] vmIpAddrs, CCredentials vmCreds)
[13.01.2011 21:13:40] <01> Info [VssGAConn] Connecting to guest via vix, hostIp '10.0.5.10', postPort '443', hostUser 'root', vmVmx '[datastore1] Windows2008x64/Windows2008x64.vmx', vmUser 'sfyit\administrator'
[1/13/2011 9:13:40 PM]Info Connecting to host [10.0.5.10] over VIX library. Login: [root].
[1/13/2011 9:15:52 PM]Info Connecting to host [10.0.5.10] over VIX library. Login: [root].. Failed.
[1/13/2011 9:15:52 PM]Error Cannot connect to host [10.0.5.10] over VIX library. Login: [root]. GuestLogin: [%3].
[1/13/2011 9:15:52 PM]Error Timeout in VixHost_Connect
[13.01.2011 21:15:52] <01> Error Cannot connect to host [10.0.5.10] over VIX library. Login: [root]. GuestLogin: [sfyit\administrator].
[13.01.2011 21:15:52] <01> Error Timeout in VixHost_Connect at VeeamGuestAgentCtrlLib.VeeamVssGAConnectionClass.ConnectByVix(String hostIPAddr, UInt16 portNumber, String hostLogin, String hostPwd, String vmxFilePath, String guestLogin, String guestPwd)
[13.01.2011 21:15:52] <01> Error at Veeam.Backup.VssProvider.CVssGAConnection.ConnectByVix(IVeeamGAConnection connection, String hostIp, UInt16 hostPort, String hostUser, String hostPass, String vmVmx, CCredentials vmCreds)
[13.01.2011 21:15:52] <01> Error at Veeam.Backup.VssProvider.CVssGAConnection.CreateEx(String hostIp, UInt16 hostPort, String hostUser, String hostPass, String vmVmx, String[] vmIpAddrs, CCredentials vmCreds)
[13.01.2011 21:15:52] <01> Error at Veeam.Backup.Core.CGuestControl..ctor(CHost host, CVm vm, CVssOptions vssOptions, CBackupTaskSession taskSess)
[13.01.2011 21:15:52] <01> Info Task operation result: 'Cannot connect to host [10.0.5.10] over VIX library. Login: [root]. GuestLogin: [sfyit\administrator].\nTimeout in VixHost_Connect'
[13.01.2011 21:15:52] <01> Info Task operation: 'Indexing guest file system'
[13.01.2011 21:15:53] <01> Info VSSIndexer: Veeam VSS index is not enabled for the VM 'Windows2008x64-.11-.12-(Exchange)'
[13.01.2011 21:15:53] <01> Info [Soap] Outgoing connection '10.0.5.10:443:root:False::0:1'.
[13.01.2011 21:15:53] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is provided from the cache.
[13.01.2011 21:15:53] <01> Info Updating information for the host"10.0.5.10"
[13.01.2011 21:15:54] <01> Info Task operation: 'Freezing guest operating system'
[13.01.2011 21:15:54] <01> Info VSSFreezer: Validating Veeam VSS freeze availability for the VM
[13.01.2011 21:15:54] <01> Error Veeam Guest Agent is not started at Veeam.Backup.Core.CGuestVssFreezer.CheckForVssAvailiable()
[13.01.2011 21:15:54] <01> Error at Veeam.Backup.Core.CGuestVssFreezer.Freeze()
[13.01.2011 21:15:54] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is disposing.
[13.01.2011 21:15:54] <01> Info [AP] Disposing client from thread 1
[13.01.2011 21:15:54] <01> Info [AP] Sending quit signal for client, host "sfy-veeam01"
[13.01.2011 21:15:55] <05> Info [AP] (Client) state: closed
[13.01.2011 21:15:55] <01> Info [AP] Stopping local agent process, pid 848, role Client
[13.01.2011 21:15:55] <05> Info [AP] (Server) state: closed
[13.01.2011 21:15:55] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is disposing.
[13.01.2011 21:15:55] <01> Info [AP] Disposing client from thread 1
[13.01.2011 21:15:55] <01> Info [AP] Sending quit signal for client, host "sfy-veeam01"
[13.01.2011 21:15:56] <05> Info [AP] (Client) state: closed
[13.01.2011 21:15:56] <01> Info [AP] Stopping local agent process, pid 4584, role Client
[13.01.2011 21:15:56] <05> Info [AP] (Server) state: closed
[13.01.2011 21:15:56] <01> Error Veeam Guest Agent is not started at Veeam.Backup.Core.CGuestVssFreezer.CheckForVssAvailiable()
[13.01.2011 21:15:56] <01> Error at Veeam.Backup.Core.CGuestVssFreezer.Freeze()
[13.01.2011 21:15:56] <01> Error at Veeam.Backup.Core.CAutoSnapshot.CreateFreezedSnapshot()
[13.01.2011 21:15:56] <01> Error at Veeam.Backup.Core.CVddkSource.Backup(IReceiver receiver)
[13.01.2011 21:15:56] <01> Error at Veeam.Backup.Core.CBackupJobPerformer.ExecuteTask(IVmBackupTask task, ITarget target, CBackupTaskSession taskSess)
[13.01.2011 21:15:56] <01> Error at Veeam.Backup.Core.CBackupJobPerformer.ExecuteTask(IBackupTask task, ITarget target)
[13.01.2011 21:15:56] <01> Info Task operation result: 'Veeam Guest Agent is not started'
[13.01.2011 21:15:56] <01> Info Task session '88f9df4e-7d8c-4397-92f1-38175458b16c' has been completed, status: 'Failed', '0' of '128,849,018,880' bytes, '0' of '0' objects, details: '\nStarting guest agent\nCannot connect to host [10.0.5.10] over VIX library. Login: [root]. GuestLogin: [sfyit\administrator].\nTimeout in VixHost_Connect\n\nFreezing guest operating system\nVeeam Guest Agent is not started\n'
[13.01.2011 21:15:56] <01> Info [Soap] Outgoing connection '10.0.5.10:443:root:False::0:1'.
[13.01.2011 21:15:56] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is provided from the cache.
[13.01.2011 21:15:56] <01> Info Updating information for the host"10.0.5.10"
[13.01.2011 21:15:57] <01> Info [VimApi] LogUserEvent, ref 16, type VirtualMachine, message "Source: Veeam Backup\nAction: Job "ExchangeRD120"\nOperation: Stopped\nStatus: Failed\nID: 88f9df4e-7d8c-4397-92f1-38175458b16c\nDescription: "
[13.01.2011 21:15:57] <01> Info [Soap] Connection '10.0.5.10:443:root:False::0:1' is disposing.
[13.01.2011 21:15:57] <01> Info Waiting for the next backup task.
[13.01.2011 21:15:57] <01> Info Completing storages in full mode
[13.01.2011 21:15:57] <01> Info Collecting storage statistic, file '\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk'
[13.01.2011 21:15:57] <01> Info [AP] Agent command: "stat\n\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk\n"
[13.01.2011 21:16:02] <09> Info [AP] (Client) output: 8429056\n
[13.01.2011 21:16:02] <09> Info [AP] (Client) output: 3560\n
[13.01.2011 21:16:02] <09> Info [AP] (Client) output: 100\n
[13.01.2011 21:16:02] <09> Info [AP] (Client) output: 100\n
[13.01.2011 21:16:02] <09> Info [AP] (Client) output: >\n
[13.01.2011 21:16:02] <01> Info [Storage] Updating storage 'My Computer:\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk:dc0f0d62-d353-462b-bbce-16f0a803cc5c', stats 'BackupSize '8429056', dataSize '3560', dedupRatio '100', compressRatio '100''
[13.01.2011 21:16:02] <01> Info [Storage] Updating storage 'My Computer:\\10.0.5.245\Veeam\VeeamVMBackup\ESX-10.0.5.10\ExchangeRD1202011-01-13T211210.vbk:dc0f0d62-d353-462b-bbce-16f0a803cc5c', modifTime '1/13/2011 9:14:10 PM'
[13.01.2011 21:16:03] <01> Info Unlocking storage(s), lockId: '5709dd8e-a9ac-4f0a-8c24-0eab0484a0ca'
[13.01.2011 21:16:03] <01> Info [Transform] Checking the need of transformation...
[13.01.2011 21:16:03] <01> Info [Transform] Transformation is not needed.
[13.01.2011 21:16:03] <01> Info Deleting empty storages from backup 'fe4c3874-6347-47ee-8081-8e6f69704e13'
[13.01.2011 21:16:03] <01> Info Job operation 'Checking free space'
[13.01.2011 21:16:03] <01> Info Job operation 'Publishing catalog session'
[13.01.2011 21:16:03] <01> Info Building oib-files matching
[13.01.2011 21:16:03] <01> Info Job operation 'Running post job command'
[13.01.2011 21:16:04] <01> Info Custom command execution disabled. Job run 0 of 1.
[13.01.2011 21:16:04] <01> Info [AP] Disposing client from thread 1
[13.01.2011 21:16:04] <01> Info [AP] Sending quit signal for client, host "sfy-veeam01"
[13.01.2011 21:16:04] <05> Info [AP] (Client) state: closed
[13.01.2011 21:16:04] <01> Info [AP] Stopping local agent process, pid 3524, role Client
[13.01.2011 21:16:05] <01> Info Job session '133e1d2d-1fec-4047-b021-2d8f6855169f' has been completed, status: 'Failed', '0.00 KB' of '120.00 GB' bytes, '1' of '1' tasks, '0' successful, '1' failed, details: '', PointId: [6d7ab3b1-24c0-4761-9710-824d9ba2bc09]
[13.01.2011 21:16:05] <01> Info [DB] Generating xml report for sessions: 133e1d2d-1fec-4047-b021-2d8f6855169f
[13.01.2011 21:16:05] <01> Info [DB] Transforming xml report to html report
[13.01.2011 21:16:06] <01> Info Sending email notification, server '10.0.5.40', port '25', timeout '100000', to 'system-alerts@hostedsfy.com'
[13.01.2011 21:16:39] <01> Info Job has been stopped successfully. Name: [ExchangeRD120], JobId: [539e1a8d-1b57-4e8d-8dab-a64e004c83d2]
[13.01.2011 21:16:39] <01> Info Unregistering TCP client channel [bstcp]
[13.01.2011 21:16:39] <01> Info Channel successfully unregistered
[13.01.2011 21:16:39] <01> Info Unregistering TCP client channel [bs_tcp]
[13.01.2011 21:16:39] <01> Info Channel successfully unregistered
[13.01.2011 21:16:39] <01> Info Unregistering TCP client channel [cat_tcp]
[13.01.2011 21:16:39] <01> Info Channel successfully unregistered
[13.01.2011 21:16:39] <01> Info Job event [ready2finish] was created.
[13.01.2011 21:16:39] <01> Info Job [ExchangeRD120] is ready to finish. SessionId: [133e1d2d-1fec-4047-b021-2d8f6855169f]
[13.01.2011 21:16:39] <01> Info Job event [ready2finish] was disposed.
[13.01.2011 21:16:39] <01> Info Job event [finished] was disposed.
[13.01.2011 21:16:39] <01> Info Job process lock was disposed.
[13.01.2011 21:16:39] <01> Info Removing from cache
[13.01.2011 21:16:39] <01> Info [Soap] Logout from "https://10.0.5.10:443/sdk"
[13.01.2011 21:16:39] <01> Info [Ssh] Clearing connection cache
[13.01.2011 21:16:39] <01> Info [Ssh] Connection cache cleared
[13.01.2011 21:16:39] <01> Info ------- Veeam Manager Stopped -------ASKER
Just remember a while back, troubleshooting a problem on the exchange server I uninstalled VmwareTools.
I'm guessing Veeam requires Vmware Tool to be installed?
Thanks Guys,
Derek
I'm guessing Veeam requires Vmware Tool to be installed?
Thanks Guys,
Derek
I'm just taking a stab in the dark here.
I assume Veeam uses VSS to snapshot and quiesce disk.? Have you investigated VSS. Is it functioning correctly.
At the moment VSS seems to be cauing me a great deal of work.
You can disable the VSS driver in VMTools!
I assume Veeam uses VSS to snapshot and quiesce disk.? Have you investigated VSS. Is it functioning correctly.
At the moment VSS seems to be cauing me a great deal of work.
You can disable the VSS driver in VMTools!
It does require Tools to quiesce the disk, if I remember correctly. VSS is an Windows technology, so Tools isn't required for that to run (or not run). Install Tools to see if that fixes the error. I've been researching the error and have come up empty. At this point, I would suggest giving Veeam a call and have them look at that job log. They can typically see what's going on pretty quickly.
~coolsport00
~coolsport00
ASKER CERTIFIED SOLUTION
membership
This solution is only available to members.
To access this solution, you must be a member of Experts Exchange.
Do you get VSS errors or Frozen I/O errors, are you using Change Block Tracking features in Veeam to Backup? (ie to reduce size to backup, track block size change to speed up backups!)
CBT seems to be causing us lots of issues at present, which is seen by Snapshot issues called by Third Pary Backup APIs. The vendors cannot do anything as it's a VMware fault.
please also see....
https://www.experts-exchange.com/questions/26731168/slow-snapshot-removal.html
and
https://www.experts-exchange.com/questions/26718729/CBT-Changed-Block-Tracking-VMWare-on-ESXi-4-1.html
let me know what you think, and I'll explain more if I can.
(not only applies to v7 virtual machines)
VMware solutioin at present is to TURN OFF/Disable CBT.
or reset it! (and this is a pain!)
CBT seems to be causing us lots of issues at present, which is seen by Snapshot issues called by Third Pary Backup APIs. The vendors cannot do anything as it's a VMware fault.
please also see....
https://www.experts-exchange.com/questions/26731168/slow-snapshot-removal.html
and
https://www.experts-exchange.com/questions/26718729/CBT-Changed-Block-Tracking-VMWare-on-ESXi-4-1.html
let me know what you think, and I'll explain more if I can.
(not only applies to v7 virtual machines)
VMware solutioin at present is to TURN OFF/Disable CBT.
or reset it! (and this is a pain!)
Isn't CBT a VSS function?
I have been having issues with guest sessions where VSS hangs.
Also issues where VSS times out during snapshot.
I have been having issues with guest sessions where VSS hangs.
Also issues where VSS times out during snapshot.
No CBT is not a VSS function. (not necessarily!) - CBT is Change Block Tracking, to track changes in the blocks in the VMDK, for faster backup. But when a Snapshot is called via API or Manual stun cycle, issues can occur.
If you are having Snapshot, VSS issues, with timeouts and Frozen I/O, carry on reading or post a question.
If you are having Snapshot, VSS issues, with timeouts and Frozen I/O, carry on reading or post a question.
Hi
@hanccocka you need to have always hw v7 to use CBT, VMs with hw v4 will not work with CBT. I have a couple of VMs with this and I cannot use this.
I need to convert this VMs into hw v7 using vConverter, since the VMs will crash after a hw upgrade. But until then I cannot use my backups on this VMs using CBT
Regarding VMs without VMware Tools, I create a test here and did not finish.
--------------------------
Backing up file "[Storage 01] VM Testing/VM Testing-flat.vmdk"
Creating snapshot
Failed to perform Veeam VSS freeze: VM guest OS state is"NotRunning"
--------------------------
After this I have change the backup, deselected the "Enable VMware Tools quiescence" and also "Enable Veeam VSS Integration", and the Backup finished with success.
I even use the CBT on this backup, and worked without any issue. So after this tests VMware Tools have no impact directly on CBT
PS: This is a normal test Windows 2003 Standard Server
Jail
@hanccocka you need to have always hw v7 to use CBT, VMs with hw v4 will not work with CBT. I have a couple of VMs with this and I cannot use this.
I need to convert this VMs into hw v7 using vConverter, since the VMs will crash after a hw upgrade. But until then I cannot use my backups on this VMs using CBT
Regarding VMs without VMware Tools, I create a test here and did not finish.
--------------------------
Backing up file "[Storage 01] VM Testing/VM Testing-flat.vmdk"
Creating snapshot
Failed to perform Veeam VSS freeze: VM guest OS state is"NotRunning"
--------------------------
After this I have change the backup, deselected the "Enable VMware Tools quiescence" and also "Enable Veeam VSS Integration", and the Backup finished with success.
I even use the CBT on this backup, and worked without any issue. So after this tests VMware Tools have no impact directly on CBT
PS: This is a normal test Windows 2003 Standard Server
Jail
@BestWay: yes, at present we do not know why some v7 machines (yes, I know v7 only) are affected by CBT/VSS/Snapshots, it's storage related, that we do know. We are still working on these issues.
You must have VMware Tools to quiescence the machine either via Sync driver of VSS.
Now there's another issues here, that VMware Tools doesn't get installed correctly on some VMs!
if you have it working good, other people do not. (and then it can stop working!)
But, I've seen errors like this on all storage platforms, MSA, EVA, NetApp, (FC, iSCSI, NFS), affecting all backups vDR, Veeam, vRanger, VCB, Netapp SMVI, it gives me a headache!
VSS issues are to do with VSS writers, not being registered correctly.
You must have VMware Tools to quiescence the machine either via Sync driver of VSS.
Now there's another issues here, that VMware Tools doesn't get installed correctly on some VMs!
if you have it working good, other people do not. (and then it can stop working!)
But, I've seen errors like this on all storage platforms, MSA, EVA, NetApp, (FC, iSCSI, NFS), affecting all backups vDR, Veeam, vRanger, VCB, Netapp SMVI, it gives me a headache!
VSS issues are to do with VSS writers, not being registered correctly.
ASKER
As soon as started the VMware tools service the backup started to run without a problem.
Thanks for everyones help.
Thanks for everyones help.
Can you please explain your environment?
Here to are you backup?? Into local Storage? SAN?
Where is Veeam installed? In a physical Server? As an appliance?
What is the hw version on that VM? Is the VMware Tools updated?
Jail