Thanks. It seems that it fails at the same place it failed before [1]. The only reason for this failure is that the disk's description is empty. Are you sure that you set a description for the right disk? Can you attach a screenshot of the VM's disk info?
[1] https://github.com/oVirt/ovirt-engine/blob/ovirt-engine-4.2.0/backend/manager/modules/utils/src/main/java/org/ovirt/engine/core/utils/ovf/OvfOvaWriter.java#L55 On Fri, Dec 29, 2017 at 12:45 AM, Alex Bartonek <a...@unix1337.com> wrote: > shut down the engine, deleted engine.log, started up and attached entire > log. It does contain a java stack dump. > > > -------- Original Message -------- > Subject: Re: [ovirt-users] Exporting/Copying VM to another oVirt server > Local Time: December 28, 2017 4:36 PM > UTC Time: December 28, 2017 10:36 PM > From: aha...@redhat.com > To: Alex Bartonek <a...@unix1337.com> > users <users@ovirt.org> > > That's weird that we don't get the stacktrace for that NPE, I wonder if we > encounter the problem that was discussed in this old thread: [1] > Could you restart the engine and try again, hoping that then we'll get the > stacktrace (it was shown previously in the engine,log and was related to > that empty disk description) > > [1] https://stackoverflow.com/questions/2411487/ > nullpointerexception-in-java-with-no-stacktrace > > On Fri, Dec 29, 2017 at 12:25 AM, Alex Bartonek <a...@unix1337.com> wrote: > >> 2017-12-28 16:14:59,452-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15462) [10f0e6a5] >> BaseAsyncTask::removeTaskFromDB: Removed task >> '3e1cfaa1-07a5-49cb-a9bc-8937c7cc75b2' from DataBase >> 2017-12-28 16:14:59,452-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15462) [10f0e6a5] >> CommandAsyncTask::HandleEndActionResult [within thread]: Removing >> CommandMultiAsyncTasks object for entity '84686e92-7ca6-4228-9d3c-31289 >> b2d1d57' >> 2017-12-28 16:15:48,805-06 INFO >> [org.ovirt.engine.core.bll.tasks.AsyncTaskManager] >> (EE-ManagedThreadFactory-engineScheduled-Thread-45) [] Setting new tasks >> map. The map contains now 1 tasks >> 2017-12-28 16:16:18,805-06 INFO >> [org.ovirt.engine.core.bll.tasks.AsyncTaskManager] >> (EE-ManagedThreadFactory-engineScheduled-Thread-5) [] Setting new tasks >> map. The map contains now 0 tasks >> 2017-12-28 16:16:18,805-06 INFO >> [org.ovirt.engine.core.bll.tasks.AsyncTaskManager] >> (EE-ManagedThreadFactory-engineScheduled-Thread-5) [] Cleared all tasks >> of pool '3bb4edf8-be27-42e4-b860-a1f1f293b81c'. >> 2017-12-28 16:21:17,538-06 INFO [org.ovirt.engine.core.bll.uti >> ls.ThreadPoolMonitoringService] >> (EE-ManagedThreadFactory-engineThreadMonitoring-Thread-1) >> [] Thread pool 'default' is using 0 threads out of 1 and 5 tasks are >> waiting in the queue. >> 2017-12-28 16:21:17,538-06 INFO [org.ovirt.engine.core.bll.uti >> ls.ThreadPoolMonitoringService] >> (EE-ManagedThreadFactory-engineThreadMonitoring-Thread-1) >> [] Thread pool 'engine' is using 0 threads out of 500, 8 threads waiting >> for tasks and 0 tasks in queue. >> 2017-12-28 16:21:17,538-06 INFO [org.ovirt.engine.core.bll.uti >> ls.ThreadPoolMonitoringService] >> (EE-ManagedThreadFactory-engineThreadMonitoring-Thread-1) >> [] Thread pool 'engineScheduled' is using 0 threads out of 100 and 100 >> tasks are waiting in the queue. >> 2017-12-28 16:21:17,538-06 INFO [org.ovirt.engine.core.bll.uti >> ls.ThreadPoolMonitoringService] >> (EE-ManagedThreadFactory-engineThreadMonitoring-Thread-1) >> [] Thread pool 'engineThreadMonitoring' is using 1 threads out of 1 and 0 >> tasks are waiting in the queue. >> 2017-12-28 16:21:17,538-06 INFO [org.ovirt.engine.core.bll.uti >> ls.ThreadPoolMonitoringService] >> (EE-ManagedThreadFactory-engineThreadMonitoring-Thread-1) >> [] Thread pool 'hostUpdatesChecker' is using 0 threads out of 5 and 2 tasks >> are waiting in the queue. >> 2017-12-28 16:21:28,068-06 INFO >> [org.ovirt.engine.core.bll.exportimport.ExportOvaCommand] >> (default task-39) [aa503a62-d439-4131-9b46-e161779847f4] Lock Acquired >> to object >> 'EngineLock:{exclusiveLocks='[43c82580-6c7a-4319-97f6-6cfb17a4445a=VM]', >> sharedLocks=''}' >> 2017-12-28 16:21:28,082-06 INFO >> [org.ovirt.engine.core.common.utils.ansible.AnsibleExecutor] >> (default task-39) [aa503a62-d439-4131-9b46-e161779847f4] Executing >> Ansible command: [/usr/bin/ansible-playbook, >> --private-key=/etc/pki/ovirt-engine/keys/engine_id_rsa, >> --inventory=/tmp/ansible-inventory8939720115375947799, >> --extra-vars=target_directory=/media/primary/extra_space, >> --extra-vars=validate_only=True, >> /usr/share/ovirt-engine/playbooks/ovirt-ova-export.yml] >> [Logfile: /var/log/ovirt-engine/ova/ovirt-export-ova-validate-ansible- >> 20171228162128-reindeer.themagicm.com-aa503a62-d439- >> 4131-9b46-e161779847f4.log] >> 2017-12-28 16:21:32,496-06 INFO >> [org.ovirt.engine.core.common.utils.ansible.AnsibleExecutor] >> (default task-39) [aa503a62-d439-4131-9b46-e161779847f4] Ansible >> playbook command has exited with value: 0 >> 2017-12-28 16:21:32,548-06 INFO >> [org.ovirt.engine.core.bll.exportimport.ExportOvaCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] Running command: ExportOvaCommand >> internal: false. Entities affected : ID: >> 43c82580-6c7a-4319-97f6-6cfb17a4445a >> Type: VMAction group IMPORT_EXPORT_VM with role type ADMIN >> 2017-12-28 16:21:32,584-06 INFO [org.ovirt.engine.core.bll.sto >> rage.disk.CreateAllOvaDisksCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] Running command: >> CreateAllOvaDisksCommand internal: true. >> 2017-12-28 16:21:32,645-06 INFO [org.ovirt.engine.core.bll.sto >> rage.disk.image.CopyImageGroupCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] Running command: >> CopyImageGroupCommand internal: true. Entities affected : ID: >> 4108dd94-7538-4fdb-a01e-2eb51b9083b9 Type: Storage >> 2017-12-28 16:21:32,757-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.CopyImageVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] START, CopyImageVDSCommand( >> CopyImageVDSCommandParameters:{storagePoolId='3bb4edf8-be27-42e4-b860-a1f1f293b81c', >> ignoreFailoverLimit='false', >> storageDomainId='4108dd94-7538-4fdb-a01e-2eb51b9083b9', >> imageGroupId='5499e522-db23-4a71-b5a2-e30933d7d547', >> imageId='5770b269-f98f-4d12-b627-e960b9e295b4', >> dstImageGroupId='a2578b49-5edf-47b8-a98a-12a20b47688c', >> vmId='43c82580-6c7a-4319-97f6-6cfb17a4445a', >> dstImageId='34885dca-e1c6-4e92-9f06-957a63c0ae56', imageDescription='', >> dstStorageDomainId='4108dd94-7538-4fdb-a01e-2eb51b9083b9', >> copyVolumeType='LeafVol', volumeFormat='COW', preallocate='Sparse', >> postZero='false', discard='false', force='true'}), log id: 40b6c4b9 >> 2017-12-28 16:21:32,760-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.CopyImageVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] -- executeIrsBrokerCommand: >> calling 'copyImage' with two new parameters: description and UUID. >> Parameters: >> 2017-12-28 16:21:32,760-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.CopyImageVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] ++ sdUUID=4108dd94-7538-4fdb-a01e >> -2eb51b9083b9 >> 2017-12-28 16:21:32,760-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.CopyImageVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] ++ spUUID=3bb4edf8-be27-42e4-b860 >> -a1f1f293b81c >> 2017-12-28 16:21:32,760-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.CopyImageVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] ++ vmGUID=43c82580-6c7a-4319-97f6 >> -6cfb17a4445a >> 2017-12-28 16:21:32,760-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.CopyImageVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] ++ srcImageGUID=5499e522-db23-4a7 >> 1-b5a2-e30933d7d547 >> 2017-12-28 16:21:32,760-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.CopyImageVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] ++ srcVolUUID=5770b269-f98f-4d12- >> b627-e960b9e295b4 >> 2017-12-28 16:21:32,760-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.CopyImageVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] ++ dstImageGUID=a2578b49-5edf-47b >> 8-a98a-12a20b47688c >> 2017-12-28 16:21:32,760-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.CopyImageVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] ++ dstVolUUID=34885dca-e1c6-4e92- >> 9f06-957a63c0ae56 >> 2017-12-28 16:21:32,760-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.CopyImageVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] ++ descr= >> 2017-12-28 16:21:32,760-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.CopyImageVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] ++ dstSdUUID=4108dd94-7538-4fdb-a >> 01e-2eb51b9083b9 >> 2017-12-28 16:21:32,858-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.CopyImageVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] FINISH, CopyImageVDSCommand, >> return: f543383a-f369-488a-b625-73706b871a51, log id: 40b6c4b9 >> 2017-12-28 16:21:32,875-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] CommandAsyncTask::Adding >> CommandMultiAsyncTasks object for command 'd8db5f12-cf59-40d2-b1b9-d5e44 >> 79766a3' >> 2017-12-28 16:21:32,876-06 INFO >> [org.ovirt.engine.core.bll.CommandMultiAsyncTasks] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] CommandMultiAsyncTasks::attachTask: >> Attaching task 'f543383a-f369-488a-b625-73706b871a51' to command >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3'. >> 2017-12-28 16:21:32,906-06 INFO >> [org.ovirt.engine.core.bll.tasks.AsyncTaskManager] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] Adding task >> 'f543383a-f369-488a-b625-73706b871a51' (Parent Command 'CopyImageGroup', >> Parameters Type 'org.ovirt.engine.core.common. >> asynctasks.AsyncTaskParameters'), polling hasn't started yet.. >> 2017-12-28 16:21:32,948-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] BaseAsyncTask::startPollingTask: >> Starting to poll task 'f543383a-f369-488a-b625-73706b871a51'. >> 2017-12-28 16:21:32,991-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] BaseAsyncTask::startPollingTask: >> Starting to poll task 'f543383a-f369-488a-b625-73706b871a51'. >> 2017-12-28 16:21:33,054-06 INFO [org.ovirt.engine.core.dal.dbb >> roker.auditloghandling.AuditLogDirector] >> (EE-ManagedThreadFactory-engine-Thread-15515) >> [aa503a62-d439-4131-9b46-e161779847f4] EVENT_ID: >> IMPORTEXPORT_STARTING_EXPORT_VM_TO_OVA(1,223), Starting to export Vm >> CentOS7 as a Virtual Appliance >> 2017-12-28 16:21:34,769-06 INFO [org.ovirt.engine.core.bll.Con >> currentChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-29) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'CreateAllOvaDisks' (id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69') waiting on child command id: >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3' type:'CopyImageGroup' to complete >> 2017-12-28 16:21:34,865-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-29) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'ExportOva' (id: >> '22e1df85-794b-4bb6-a6b6-a1679cbe2f78') waiting on child command id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69' type:'CreateAllOvaDisks' to >> complete >> 2017-12-28 16:21:38,872-06 INFO [org.ovirt.engine.core.bll.Con >> currentChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-77) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'CreateAllOvaDisks' (id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69') waiting on child command id: >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3' type:'CopyImageGroup' to complete >> 2017-12-28 16:21:38,883-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-77) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'ExportOva' (id: >> '22e1df85-794b-4bb6-a6b6-a1679cbe2f78') waiting on child command id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69' type:'CreateAllOvaDisks' to >> complete >> 2017-12-28 16:21:39,355-06 INFO >> [org.ovirt.engine.core.bll.tasks.AsyncTaskManager] >> (EE-ManagedThreadFactory-engineScheduled-Thread-64) [] Polling and >> updating Async Tasks: 1 tasks, 1 tasks to poll now >> 2017-12-28 16:21:39,366-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engineScheduled-Thread-64) [] >> SPMAsyncTask::PollTask: Polling task 'f543383a-f369-488a-b625-73706b871a51' >> (Parent Command 'CopyImageGroup', Parameters Type >> 'org.ovirt.engine.core.common.asynctasks.AsyncTaskParameters') returned >> status 'running'. >> 2017-12-28 16:21:39,367-06 INFO >> [org.ovirt.engine.core.bll.tasks.AsyncTaskManager] >> (EE-ManagedThreadFactory-engineScheduled-Thread-64) [] Finished polling >> Tasks, will poll again in 10 seconds. >> 2017-12-28 16:21:46,893-06 INFO [org.ovirt.engine.core.bll.Con >> currentChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-7) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'CreateAllOvaDisks' (id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69') waiting on child command id: >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3' type:'CopyImageGroup' to complete >> 2017-12-28 16:21:46,903-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-7) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'ExportOva' (id: >> '22e1df85-794b-4bb6-a6b6-a1679cbe2f78') waiting on child command id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69' type:'CreateAllOvaDisks' to >> complete >> 2017-12-28 16:21:56,916-06 INFO [org.ovirt.engine.core.bll.Con >> currentChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-92) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'CreateAllOvaDisks' (id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69') waiting on child command id: >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3' type:'CopyImageGroup' to complete >> 2017-12-28 16:21:56,926-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-92) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'ExportOva' (id: >> '22e1df85-794b-4bb6-a6b6-a1679cbe2f78') waiting on child command id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69' type:'CreateAllOvaDisks' to >> complete >> 2017-12-28 16:22:06,935-06 INFO [org.ovirt.engine.core.bll.Con >> currentChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-38) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'CreateAllOvaDisks' (id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69') waiting on child command id: >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3' type:'CopyImageGroup' to complete >> 2017-12-28 16:22:06,945-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-38) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'ExportOva' (id: >> '22e1df85-794b-4bb6-a6b6-a1679cbe2f78') waiting on child command id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69' type:'CreateAllOvaDisks' to >> complete >> 2017-12-28 16:22:16,956-06 INFO [org.ovirt.engine.core.bll.Con >> currentChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-15) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'CreateAllOvaDisks' (id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69') waiting on child command id: >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3' type:'CopyImageGroup' to complete >> 2017-12-28 16:22:16,966-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-15) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'ExportOva' (id: >> '22e1df85-794b-4bb6-a6b6-a1679cbe2f78') waiting on child command id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69' type:'CreateAllOvaDisks' to >> complete >> 2017-12-28 16:22:26,974-06 INFO [org.ovirt.engine.core.bll.Con >> currentChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-58) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'CreateAllOvaDisks' (id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69') waiting on child command id: >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3' type:'CopyImageGroup' to complete >> 2017-12-28 16:22:26,995-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-58) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'ExportOva' (id: >> '22e1df85-794b-4bb6-a6b6-a1679cbe2f78') waiting on child command id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69' type:'CreateAllOvaDisks' to >> complete >> 2017-12-28 16:22:37,004-06 INFO [org.ovirt.engine.core.bll.Con >> currentChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-2) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'CreateAllOvaDisks' (id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69') waiting on child command id: >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3' type:'CopyImageGroup' to complete >> 2017-12-28 16:22:37,016-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-2) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'ExportOva' (id: >> '22e1df85-794b-4bb6-a6b6-a1679cbe2f78') waiting on child command id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69' type:'CreateAllOvaDisks' to >> complete >> 2017-12-28 16:22:47,023-06 INFO [org.ovirt.engine.core.bll.Con >> currentChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-5) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'CreateAllOvaDisks' (id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69') waiting on child command id: >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3' type:'CopyImageGroup' to complete >> 2017-12-28 16:22:47,036-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-5) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'ExportOva' (id: >> '22e1df85-794b-4bb6-a6b6-a1679cbe2f78') waiting on child command id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69' type:'CreateAllOvaDisks' to >> complete >> 2017-12-28 16:22:57,045-06 INFO [org.ovirt.engine.core.bll.Con >> currentChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-77) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'CreateAllOvaDisks' (id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69') waiting on child command id: >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3' type:'CopyImageGroup' to complete >> 2017-12-28 16:22:57,055-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-77) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'ExportOva' (id: >> '22e1df85-794b-4bb6-a6b6-a1679cbe2f78') waiting on child command id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69' type:'CreateAllOvaDisks' to >> complete >> 2017-12-28 16:22:59,497-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engineScheduled-Thread-23) [] >> SPMAsyncTask::PollTask: Polling task 'f543383a-f369-488a-b625-73706b871a51' >> (Parent Command 'CopyImageGroup', Parameters Type >> 'org.ovirt.engine.core.common.asynctasks.AsyncTaskParameters') returned >> status 'finished', result 'success'. >> 2017-12-28 16:22:59,503-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engineScheduled-Thread-23) [] >> BaseAsyncTask::onTaskEndSuccess: Task 'f543383a-f369-488a-b625-73706b871a51' >> (Parent Command 'CopyImageGroup', Parameters Type >> 'org.ovirt.engine.core.common.asynctasks.AsyncTaskParameters') ended >> successfully. >> 2017-12-28 16:22:59,504-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engineScheduled-Thread-23) [] >> CommandAsyncTask::endActionIfNecessary: All tasks of command >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3' has ended -> executing 'endAction' >> 2017-12-28 16:22:59,505-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engineScheduled-Thread-23) [] >> CommandAsyncTask::endAction: Ending action for '1' tasks (command ID: >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3'): calling endAction '. >> 2017-12-28 16:22:59,505-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15528) [] >> CommandAsyncTask::endCommandAction [within thread] context: Attempting >> to endAction 'CopyImageGroup', >> 2017-12-28 16:22:59,515-06 INFO [org.ovirt.engine.core.bll.sto >> rage.disk.image.CopyImageGroupCommand] >> (EE-ManagedThreadFactory-engine-Thread-15528) >> [aa503a62-d439-4131-9b46-e161779847f4] Command >> [id=d8db5f12-cf59-40d2-b1b9-d5e4479766a3]: Updating status to >> 'SUCCEEDED', The command end method logic will be executed by one of its >> parent commands. >> 2017-12-28 16:22:59,516-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15528) >> [aa503a62-d439-4131-9b46-e161779847f4] >> CommandAsyncTask::HandleEndActionResult >> [within thread]: endAction for action type 'CopyImageGroup' completed, >> handling the result. >> 2017-12-28 16:22:59,516-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15528) >> [aa503a62-d439-4131-9b46-e161779847f4] >> CommandAsyncTask::HandleEndActionResult >> [within thread]: endAction for action type 'CopyImageGroup' succeeded, >> clearing tasks. >> 2017-12-28 16:22:59,516-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15528) >> [aa503a62-d439-4131-9b46-e161779847f4] SPMAsyncTask::ClearAsyncTask: >> Attempting to clear task 'f543383a-f369-488a-b625-73706b871a51' >> 2017-12-28 16:22:59,518-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.SPMClearTaskVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15528) >> [aa503a62-d439-4131-9b46-e161779847f4] START, SPMClearTaskVDSCommand( >> SPMTaskGuidBaseVDSCommandParameters:{storagePoolId='3bb4edf8-be27-42e4-b860-a1f1f293b81c', >> ignoreFailoverLimit='false', taskId='f543383a-f369-488a-b625-73706b871a51'}), >> log id: 2e9c1d1 >> 2017-12-28 16:22:59,521-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.HSMClearTaskVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15528) >> [aa503a62-d439-4131-9b46-e161779847f4] START, >> HSMClearTaskVDSCommand(HostName = reindeerHost, >> HSMTaskGuidBaseVDSCommandParameters:{hostId='4f344875-08d8-49d8-b2ee-5ca3e1810051', >> taskId='f543383a-f369-488a-b625-73706b871a51'}), log id: 4ad7abb5 >> 2017-12-28 16:22:59,535-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.HSMClearTaskVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15528) >> [aa503a62-d439-4131-9b46-e161779847f4] FINISH, HSMClearTaskVDSCommand, >> log id: 4ad7abb5 >> 2017-12-28 16:22:59,535-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.SPMClearTaskVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15528) >> [aa503a62-d439-4131-9b46-e161779847f4] FINISH, SPMClearTaskVDSCommand, >> log id: 2e9c1d1 >> 2017-12-28 16:22:59,545-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15528) >> [aa503a62-d439-4131-9b46-e161779847f4] BaseAsyncTask::removeTaskFromDB: >> Removed task 'f543383a-f369-488a-b625-73706b871a51' from DataBase >> 2017-12-28 16:22:59,546-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15528) >> [aa503a62-d439-4131-9b46-e161779847f4] >> CommandAsyncTask::HandleEndActionResult >> [within thread]: Removing CommandMultiAsyncTasks object for entity >> 'd8db5f12-cf59-40d2-b1b9-d5e4479766a3' >> 2017-12-28 16:23:07,064-06 INFO [org.ovirt.engine.core.bll.Con >> currentChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-45) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'CreateAllOvaDisks' id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69' child commands >> '[d8db5f12-cf59-40d2-b1b9-d5e4479766a3]' executions were completed, >> status 'SUCCEEDED' >> 2017-12-28 16:23:07,078-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-45) >> [aa503a62-d439-4131-9b46-e161779847f4] Command 'ExportOva' (id: >> '22e1df85-794b-4bb6-a6b6-a1679cbe2f78') waiting on child command id: >> '42331a77-2e38-4653-ba5f-29e5dccaea69' type:'CreateAllOvaDisks' to >> complete >> 2017-12-28 16:23:08,089-06 INFO [org.ovirt.engine.core.bll.sto >> rage.disk.CreateAllOvaDisksCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [aa503a62-d439-4131-9b46-e161779847f4] Ending command >> 'org.ovirt.engine.core.bll.storage.disk.CreateAllOvaDisksCommand' >> successfully. >> 2017-12-28 16:23:08,106-06 INFO [org.ovirt.engine.core.bll.sto >> rage.disk.image.CopyImageGroupCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [aa503a62-d439-4131-9b46-e161779847f4] Ending command >> 'org.ovirt.engine.core.bll.storage.disk.image.CopyImageGroupCommand' >> successfully. >> 2017-12-28 16:23:08,118-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.GetImageInfoVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [aa503a62-d439-4131-9b46-e161779847f4] START, GetImageInfoVDSCommand( >> GetImageInfoVDSCommandParameters:{storagePoolId='3bb4edf8-be27-42e4-b860-a1f1f293b81c', >> ignoreFailoverLimit='false', >> storageDomainId='4108dd94-7538-4fdb-a01e-2eb51b9083b9', >> imageGroupId='a2578b49-5edf-47b8-a98a-12a20b47688c', >> imageId='34885dca-e1c6-4e92-9f06-957a63c0ae56'}), log id: 2cec8f8 >> 2017-12-28 16:23:08,122-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.GetVolumeInfoVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [aa503a62-d439-4131-9b46-e161779847f4] START, >> GetVolumeInfoVDSCommand(HostName = reindeerHost, >> GetVolumeInfoVDSCommandParameters:{hostId='4f344875-08d8-49d8-b2ee-5ca3e1810051', >> storagePoolId='3bb4edf8-be27-42e4-b860-a1f1f293b81c', >> storageDomainId='4108dd94-7538-4fdb-a01e-2eb51b9083b9', >> imageGroupId='a2578b49-5edf-47b8-a98a-12a20b47688c', >> imageId='34885dca-e1c6-4e92-9f06-957a63c0ae56'}), log id: c3fea19 >> 2017-12-28 16:23:08,135-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.GetVolumeInfoVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [aa503a62-d439-4131-9b46-e161779847f4] FINISH, GetVolumeInfoVDSCommand, >> return: org.ovirt.engine.core.common.businessentities.storage.DiskIm >> age@95bb5b65, log id: c3fea19 >> 2017-12-28 16:23:08,135-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.GetImageInfoVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [aa503a62-d439-4131-9b46-e161779847f4] FINISH, GetImageInfoVDSCommand, >> return: org.ovirt.engine.core.common.businessentities.storage.DiskIm >> age@95bb5b65, log id: 2cec8f8 >> 2017-12-28 16:23:08,232-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.PrepareImageVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [aa503a62-d439-4131-9b46-e161779847f4] START, >> PrepareImageVDSCommand(HostName = reindeerHost, >> PrepareImageVDSCommandParameters:{hostId='4f344875-08d8-49d8-b2ee-5ca3e1810051'}), >> log id: 6824c68f >> 2017-12-28 16:23:08,246-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.PrepareImageVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [aa503a62-d439-4131-9b46-e161779847f4] FINISH, PrepareImageVDSCommand, >> return: PrepareImageReturn:{status='Status [code=0, message=Done]'}, log >> id: 6824c68f >> 2017-12-28 16:23:08,251-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.GetQemuImageInfoVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [aa503a62-d439-4131-9b46-e161779847f4] START, >> GetQemuImageInfoVDSCommand(HostName = reindeerHost, >> GetVolumeInfoVDSCommandParameters:{hostId='4f344875-08d8-49d8-b2ee-5ca3e1810051', >> storagePoolId='3bb4edf8-be27-42e4-b860-a1f1f293b81c', >> storageDomainId='4108dd94-7538-4fdb-a01e-2eb51b9083b9', >> imageGroupId='a2578b49-5edf-47b8-a98a-12a20b47688c', >> imageId='34885dca-e1c6-4e92-9f06-957a63c0ae56'}), log id: 1fb3c78e >> 2017-12-28 16:23:08,495-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.GetQemuImageInfoVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [aa503a62-d439-4131-9b46-e161779847f4] FINISH, >> GetQemuImageInfoVDSCommand, return: org.ovirt.engine.core.common.b >> usinessentities.storage.QemuImageInfo@3412697c, log id: 1fb3c78e >> 2017-12-28 16:23:08,499-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.TeardownImageVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [aa503a62-d439-4131-9b46-e161779847f4] START, >> TeardownImageVDSCommand(HostName = reindeerHost, >> ImageActionsVDSCommandParameters:{hostId='4f344875-08d8-49d8-b2ee-5ca3e1810051'}), >> log id: 6377d6a3 >> 2017-12-28 16:23:08,508-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.TeardownImageVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [aa503a62-d439-4131-9b46-e161779847f4] FINISH, TeardownImageVDSCommand, >> return: StatusReturn:{status='Status [code=0, message=Done]'}, log id: >> 6377d6a3 >> 2017-12-28 16:23:08,561-06 INFO [org.ovirt.engine.core.bll.CreateOvaCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) [436aa42a] Running >> command: CreateOvaCommand internal: true. >> 2017-12-28 16:23:08,564-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.PrepareImageVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [436aa42a] START, PrepareImageVDSCommand(HostName = reindeerHost, >> PrepareImageVDSCommandParameters:{hostId='4f344875-08d8-49d8-b2ee-5ca3e1810051'}), >> log id: 4490da3c >> 2017-12-28 16:23:08,575-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.PrepareImageVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [436aa42a] FINISH, PrepareImageVDSCommand, return: >> PrepareImageReturn:{status='Status [code=0, message=Done]'}, log id: >> 4490da3c >> 2017-12-28 16:23:08,580-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.GetVolumeInfoVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [436aa42a] START, GetVolumeInfoVDSCommand(HostName = reindeerHost, >> GetVolumeInfoVDSCommandParameters:{hostId='4f344875-08d8-49d8-b2ee-5ca3e1810051', >> storagePoolId='3bb4edf8-be27-42e4-b860-a1f1f293b81c', >> storageDomainId='4108dd94-7538-4fdb-a01e-2eb51b9083b9', >> imageGroupId='a2578b49-5edf-47b8-a98a-12a20b47688c', >> imageId='34885dca-e1c6-4e92-9f06-957a63c0ae56'}), log id: 60f52262 >> 2017-12-28 16:23:08,591-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.GetVolumeInfoVDSCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [436aa42a] FINISH, GetVolumeInfoVDSCommand, return: >> org.ovirt.engine.core.common.businessentities.storage.DiskImage@95bb5b65, >> log id: 60f52262 >> 2017-12-28 16:23:08,596-06 ERROR [org.ovirt.engine.core.bll.CreateOvaCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) [436aa42a] Command >> 'org.ovirt.engine.core.bll.CreateOvaCommand' failed: null >> 2017-12-28 16:23:08,596-06 ERROR [org.ovirt.engine.core.bll.CreateOvaCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) [436aa42a] >> Exception: java.lang.NullPointerException >> >> 2017-12-28 16:23:08,600-06 ERROR >> [org.ovirt.engine.core.bll.exportimport.ExportOvaCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) [436aa42a] Failed to >> create OVA file >> 2017-12-28 16:23:08,600-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [436aa42a] Command 'ExportOva' id: '22e1df85-794b-4bb6-a6b6-a1679cbe2f78' >> failed when attempting to perform the next operation, marking as FAILED >> '[42331a77-2e38-4653-ba5f-29e5dccaea69]' >> 2017-12-28 16:23:08,600-06 INFO [org.ovirt.engine.core.bll.Ser >> ialChildCommandsExecutionCallback] >> (EE-ManagedThreadFactory-engineScheduled-Thread-61) >> [436aa42a] Command 'ExportOva' id: '22e1df85-794b-4bb6-a6b6-a1679cbe2f78' >> child commands '[42331a77-2e38-4653-ba5f-29e5dccaea69]' executions were >> completed, status 'FAILED' >> 2017-12-28 16:23:09,628-06 ERROR >> [org.ovirt.engine.core.bll.exportimport.ExportOvaCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-15) >> [aa503a62-d439-4131-9b46-e161779847f4] Ending command >> 'org.ovirt.engine.core.bll.exportimport.ExportOvaCommand' with failure. >> 2017-12-28 16:23:09,637-06 INFO >> [org.ovirt.engine.core.bll.exportimport.ExportOvaCommand] >> (EE-ManagedThreadFactory-engineScheduled-Thread-15) >> [aa503a62-d439-4131-9b46-e161779847f4] Lock freed to object >> 'EngineLock:{exclusiveLocks='[43c82580-6c7a-4319-97f6-6cfb17a4445a=VM]', >> sharedLocks=''}' >> 2017-12-28 16:23:09,667-06 ERROR [org.ovirt.engine.core.dal.dbb >> roker.auditloghandling.AuditLogDirector] >> (EE-ManagedThreadFactory-engineScheduled-Thread-15) >> [aa503a62-d439-4131-9b46-e161779847f4] EVENT_ID: >> IMPORTEXPORT_EXPORT_VM_TO_OVA_FAILED(1,225), Failed to export Vm CentOS7 >> as a Virtual Appliance to path /media/primary/extra_space/CentOS7.ova on >> Host reindeerHost >> 2017-12-28 16:23:09,716-06 INFO >> [org.ovirt.engine.core.bll.storage.disk.RemoveDiskCommand] >> (EE-ManagedThreadFactory-engine-Thread-15529) [31f8fbf6] Running >> command: RemoveDiskCommand internal: true. Entities affected : ID: >> a2578b49-5edf-47b8-a98a-12a20b47688c Type: DiskAction group DELETE_DISK >> with role type USER >> 2017-12-28 16:23:09,734-06 INFO [org.ovirt.engine.core.bll.sto >> rage.disk.image.RemoveImageCommand] >> (EE-ManagedThreadFactory-engine-Thread-15529) >> [31f8fbf6] Running command: RemoveImageCommand internal: true. Entities >> affected : ID: 4108dd94-7538-4fdb-a01e-2eb51b9083b9 Type: Storage >> 2017-12-28 16:23:09,796-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.DeleteImageGroupVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15529) >> [31f8fbf6] START, DeleteImageGroupVDSCommand( DeleteImageGroupVDSCommandPara >> meters:{storagePoolId='3bb4edf8-be27-42e4-b860-a1f1f293b81c', >> ignoreFailoverLimit='false', >> storageDomainId='4108dd94-7538-4fdb-a01e-2eb51b9083b9', >> imageGroupId='a2578b49-5edf-47b8-a98a-12a20b47688c', postZeros='false', >> discard='false', forceDelete='true'}), log id: 389abdf >> 2017-12-28 16:23:09,845-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.DeleteImageGroupVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15529) >> [31f8fbf6] FINISH, DeleteImageGroupVDSCommand, log id: 389abdf >> 2017-12-28 16:23:09,860-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15529) [31f8fbf6] >> CommandAsyncTask::Adding CommandMultiAsyncTasks object for command >> 'f9ca5d6f-effe-41a2-835f-83f04da2de73' >> 2017-12-28 16:23:09,860-06 INFO >> [org.ovirt.engine.core.bll.CommandMultiAsyncTasks] >> (EE-ManagedThreadFactory-engine-Thread-15529) [31f8fbf6] >> CommandMultiAsyncTasks::attachTask: Attaching task >> 'f2c7f5ec-b166-4cf2-97b6-b2cc02f715e1' to command >> 'f9ca5d6f-effe-41a2-835f-83f04da2de73'. >> 2017-12-28 16:23:09,888-06 INFO >> [org.ovirt.engine.core.bll.tasks.AsyncTaskManager] >> (EE-ManagedThreadFactory-engine-Thread-15529) [31f8fbf6] Adding task >> 'f2c7f5ec-b166-4cf2-97b6-b2cc02f715e1' (Parent Command 'RemoveDisk', >> Parameters Type 'org.ovirt.engine.core.common. >> asynctasks.AsyncTaskParameters'), polling hasn't started yet.. >> 2017-12-28 16:23:10,056-06 INFO [org.ovirt.engine.core.dal.dbb >> roker.auditloghandling.AuditLogDirector] >> (EE-ManagedThreadFactory-engine-Thread-15529) >> [31f8fbf6] EVENT_ID: USER_FINISHED_REMOVE_DISK(2,014), Disk >> Debian7_Disk1 was successfully removed from domain data (User >> admin@internal-authz). >> 2017-12-28 16:23:10,057-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15529) [31f8fbf6] >> BaseAsyncTask::startPollingTask: Starting to poll task >> 'f2c7f5ec-b166-4cf2-97b6-b2cc02f715e1'. >> 2017-12-28 16:23:10,057-06 WARN >> [org.ovirt.engine.core.bll.lock.InMemoryLockManager] >> (EE-ManagedThreadFactory-engine-Thread-15529) [31f8fbf6] Trying to >> release exclusive lock which does not exist, lock key: >> '43c82580-6c7a-4319-97f6-6cfb17a4445aVM' >> 2017-12-28 16:23:10,057-06 INFO >> [org.ovirt.engine.core.bll.storage.disk.RemoveDiskCommand] >> (EE-ManagedThreadFactory-engine-Thread-15529) [31f8fbf6] Lock freed to >> object >> 'EngineLock:{exclusiveLocks='[43c82580-6c7a-4319-97f6-6cfb17a4445a=VM]', >> sharedLocks=''}' >> 2017-12-28 16:23:19,505-06 INFO >> [org.ovirt.engine.core.bll.tasks.AsyncTaskManager] >> (EE-ManagedThreadFactory-engineScheduled-Thread-31) [] Polling and >> updating Async Tasks: 2 tasks, 1 tasks to poll now >> 2017-12-28 16:23:19,519-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engineScheduled-Thread-31) [] >> SPMAsyncTask::PollTask: Polling task 'f2c7f5ec-b166-4cf2-97b6-b2cc02f715e1' >> (Parent Command 'RemoveDisk', Parameters Type 'org.ovirt.engine.core.common. >> asynctasks.AsyncTaskParameters') returned status 'finished', result >> 'success'. >> 2017-12-28 16:23:19,530-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engineScheduled-Thread-31) [] >> BaseAsyncTask::onTaskEndSuccess: Task 'f2c7f5ec-b166-4cf2-97b6-b2cc02f715e1' >> (Parent Command 'RemoveDisk', Parameters Type 'org.ovirt.engine.core.common. >> asynctasks.AsyncTaskParameters') ended successfully. >> 2017-12-28 16:23:19,563-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engineScheduled-Thread-31) [] >> CommandAsyncTask::endActionIfNecessary: All tasks of command >> 'f9ca5d6f-effe-41a2-835f-83f04da2de73' has ended -> executing 'endAction' >> 2017-12-28 16:23:19,563-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engineScheduled-Thread-31) [] >> CommandAsyncTask::endAction: Ending action for '1' tasks (command ID: >> 'f9ca5d6f-effe-41a2-835f-83f04da2de73'): calling endAction '. >> 2017-12-28 16:23:19,564-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15532) [] >> CommandAsyncTask::endCommandAction [within thread] context: Attempting >> to endAction 'RemoveDisk', >> 2017-12-28 16:23:19,579-06 INFO >> [org.ovirt.engine.core.bll.storage.disk.RemoveDiskCommand] >> (EE-ManagedThreadFactory-engine-Thread-15532) [31f8fbf6] Ending command >> 'org.ovirt.engine.core.bll.storage.disk.RemoveDiskCommand' successfully. >> 2017-12-28 16:23:19,585-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15532) [31f8fbf6] >> CommandAsyncTask::HandleEndActionResult [within thread]: endAction for >> action type 'RemoveDisk' completed, handling the result. >> 2017-12-28 16:23:19,585-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15532) [31f8fbf6] >> CommandAsyncTask::HandleEndActionResult [within thread]: endAction for >> action type 'RemoveDisk' succeeded, clearing tasks. >> 2017-12-28 16:23:19,585-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15532) [31f8fbf6] >> SPMAsyncTask::ClearAsyncTask: Attempting to clear task >> 'f2c7f5ec-b166-4cf2-97b6-b2cc02f715e1' >> 2017-12-28 16:23:19,588-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.SPMClearTaskVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15532) >> [31f8fbf6] START, SPMClearTaskVDSCommand( SPMTaskGuidBaseVDSCommandParam >> eters:{storagePoolId='3bb4edf8-be27-42e4-b860-a1f1f293b81c', >> ignoreFailoverLimit='false', taskId='f2c7f5ec-b166-4cf2-97b6-b2cc02f715e1'}), >> log id: 6c25b62 >> 2017-12-28 16:23:19,591-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.HSMClearTaskVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15532) >> [31f8fbf6] START, HSMClearTaskVDSCommand(HostName = reindeerHost, >> HSMTaskGuidBaseVDSCommandParameters:{hostId='4f344875-08d8-49d8-b2ee-5ca3e1810051', >> taskId='f2c7f5ec-b166-4cf2-97b6-b2cc02f715e1'}), log id: 4d4fcced >> 2017-12-28 16:23:19,602-06 INFO [org.ovirt.engine.core.vdsbrok >> er.vdsbroker.HSMClearTaskVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15532) >> [31f8fbf6] FINISH, HSMClearTaskVDSCommand, log id: 4d4fcced >> 2017-12-28 16:23:19,602-06 INFO [org.ovirt.engine.core.vdsbrok >> er.irsbroker.SPMClearTaskVDSCommand] >> (EE-ManagedThreadFactory-engine-Thread-15532) >> [31f8fbf6] FINISH, SPMClearTaskVDSCommand, log id: 6c25b62 >> 2017-12-28 16:23:19,614-06 INFO >> [org.ovirt.engine.core.bll.tasks.SPMAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15532) [31f8fbf6] >> BaseAsyncTask::removeTaskFromDB: Removed task >> 'f2c7f5ec-b166-4cf2-97b6-b2cc02f715e1' from DataBase >> 2017-12-28 16:23:19,614-06 INFO >> [org.ovirt.engine.core.bll.tasks.CommandAsyncTask] >> (EE-ManagedThreadFactory-engine-Thread-15532) [31f8fbf6] >> CommandAsyncTask::HandleEndActionResult [within thread]: Removing >> CommandMultiAsyncTasks object for entity 'f9ca5d6f-effe-41a2-835f-83f04 >> da2de73' >> 2017-12-28 16:24:18,808-06 INFO >> [org.ovirt.engine.core.bll.tasks.AsyncTaskManager] >> (EE-ManagedThreadFactory-engineScheduled-Thread-55) [] Setting new tasks >> map. The map contains now 1 tasks >> >> >> >> Sent with ProtonMail <https://protonmail.com> Secure Email. >> >> -------- Original Message -------- >> Subject: Re: [ovirt-users] Exporting/Copying VM to another oVirt server >> Local Time: December 28, 2017 4:20 PM >> UTC Time: December 28, 2017 10:20 PM >> From: aha...@redhat.com >> To: Alex Bartonek <a...@unix1337.com> >> users <users@ovirt.org> >> >> :/ >> Can you please attach the new log? >> >> On Fri, Dec 29, 2017 at 12:18 AM, Alex Bartonek <a...@unix1337.com> >> wrote: >> >>> Yes it was empty. Tried again, same failure. >>> >>> >>> Sent with ProtonMail <https://protonmail.com> Secure Email. >>> >>> -------- Original Message -------- >>> Subject: Re: [ovirt-users] Exporting/Copying VM to another oVirt server >>> Local Time: December 28, 2017 4:11 PM >>> UTC Time: December 28, 2017 10:11 PM >>> From: aha...@redhat.com >>> To: Alex Bartonek <a...@unix1337.com> >>> users <users@ovirt.org> >>> >>> Thanks. >>> Is the description of the disk of the VM empty? >>> If it is, please type some description and then try again. >>> >>> On Fri, Dec 29, 2017 at 12:02 AM, Alex Bartonek <a...@unix1337.com> >>> wrote: >>> >>>> Attached. Its 3.8 mb decompressed. >>>> >>>> >>>> Sent with ProtonMail <https://protonmail.com> Secure Email. >>>> >>>> -------- Original Message -------- >>>> Subject: Re: [ovirt-users] Exporting/Copying VM to another oVirt server >>>> Local Time: December 28, 2017 3:56 PM >>>> UTC Time: December 28, 2017 9:56 PM >>>> From: aha...@redhat.com >>>> To: Alex Bartonek <a...@unix1337.com> >>>> users <users@ovirt.org> >>>> >>>> >>>> >>>> On Thu, Dec 28, 2017 at 11:28 PM, Alex Bartonek <a...@unix1337.com> >>>> wrote: >>>> >>>>> That is the excerpt from the engine log file. There isnt any more >>>>> java stack dump in it other than what I captured. >>>>> >>>> >>>> Can you please attach the entire engine.log to this thread or to a new >>>> bug (https://bugzilla.redhat.com)? >>>> >>>> >>>>> >>>>> >>>>> >>>>> Sent with ProtonMail <https://protonmail.com> Secure Email. >>>>> >>>>> -------- Original Message -------- >>>>> Subject: Re: [ovirt-users] Exporting/Copying VM to another oVirt server >>>>> Local Time: December 28, 2017 3:18 PM >>>>> UTC Time: December 28, 2017 9:18 PM >>>>> From: aha...@redhat.com >>>>> To: Alex Bartonek <a...@unix1337.com> >>>>> users <users@ovirt.org> >>>>> >>>>> >>>>> >>>>> On Thu, Dec 28, 2017 at 10:46 PM, Alex Bartonek <a...@unix1337.com> >>>>> wrote: >>>>> >>>>>> Log uploaded to: >>>>>> >>>>>> http://textuploader.com/dc2be >>>>>> >>>>>> >>>>> Thanks! >>>>> Exporting and importing as OVA files is the new shiny way of doing >>>>> that as from 4.2 but unfortunately, there seems to be an error while >>>>> generating OVF for the VM you're trying to export. >>>>> I see NullPointerException in the log and an empty line afterwards, >>>>> can you please check if there is a stacktrace right below in the >>>>> engine.log >>>>> that was not copied? It should be below: >>>>> 2017-12-28 14:45:03,728-06 ERROR >>>>> [org.ovirt.engine.core.bll.CreateOvaCommand] >>>>> (EE-ManagedThreadFactory-engineScheduled-Thread-22) [38896e98] >>>>> Exception: java.lang.NullPointerException >>>>> >>>>> >>>>>> >>>>>> >>>>>> >>>>>> >>>>>> -------- Original Message -------- >>>>>> Subject: Re: [ovirt-users] Exporting/Copying VM to another oVirt >>>>>> server >>>>>> Local Time: December 28, 2017 2:41 PM >>>>>> UTC Time: December 28, 2017 8:41 PM >>>>>> From: aha...@redhat.com >>>>>> To: Alex Bartonek <a...@unix1337.com> >>>>>> users <users@ovirt.org> >>>>>> >>>>>> >>>>>> >>>>>> בתאריך 28 בדצמ׳ 2017 10:38 PM, "Alex Bartonek" <a...@unix1337.com> >>>>>> כתב: >>>>>> >>>>>> After the success of getting my VM's working on my test server, I >>>>>> decided to wipe out another server I had and wanted to move my VMs to it. >>>>>> I tried the "Export" as ova and it seems to work but in the Tasks its >>>>>> red: >>>>>> >>>>>> "Exporting VM CentOS7 as an OVA to /ovirt_data/CentOS7.ova on Host >>>>>> junkHost". >>>>>> >>>>>> The .ova is never created. Is there another way to do this? Both >>>>>> servers are running 4.2. >>>>>> >>>>>> Googling hasnt helped me find a solution yet... >>>>>> >>>>>> >>>>>> Can you please share engine.log? >>>>>> >>>>>> >>>>>> >>>>>> _______________________________________________ >>>>>> Users mailing list >>>>>> Users@ovirt.org >>>>>> http://lists.ovirt.org/mailman/listinfo/users >>>>>> >>>>>> >>>>>> >>>>> >>>> >>> >> >
_______________________________________________ Users mailing list Users@ovirt.org http://lists.ovirt.org/mailman/listinfo/users