Bug 1223838 - Cannot add Virtual Machine Disk due to a permissions error related to Disk Profiles
Summary: Cannot add Virtual Machine Disk due to a permissions error related to Disk Pr...
Keywords:
Status: CLOSED NOTABUG
Alias: None
Product: Red Hat Enterprise Virtualization Manager
Classification: Red Hat
Component: ovirt-engine
Version: 3.5.1
Hardware: All
OS: Linux
medium
urgent
Target Milestone: ---
: 3.5.5
Assignee: Roy Golan
QA Contact:
URL:
Whiteboard: sla
Depends On:
Blocks:
TreeView+ depends on / blocked
 
Reported: 2015-05-21 14:09 UTC by Allie DeVolder
Modified: 2019-07-16 12:00 UTC (History)
12 users (show)

Fixed In Version:
Doc Type: Bug Fix
Doc Text:
Clone Of:
Environment:
Last Closed: 2015-06-11 05:46:32 UTC
oVirt Team: SLA
Target Upstream Version:
Embargoed:


Attachments (Terms of Use)
latest ovirt-engine-setup log file (1.85 MB, text/plain)
2015-06-02 12:04 UTC, Paul Stauffer
no flags Details

Description Allie DeVolder 2015-05-21 14:09:28 UTC
Description of problem:
When attempting to create a new VM disk, RHEV-M cancels the operation with the following error in a pop up dialogue box:

Error while executing action: Cannot add Virtual Machine Disk. The user doesn't have permissions to attach Disk Profile to the Disk

This happens with both the admin@internal user and a domain user with the Superuser role assigned. This occurs even when explicitly adding that user the this VMs permissions as someone who can create a disk.

This also occurs when attempting to create a disk from the Disks tab, independent of the VM. 

Version-Release number of selected component (if applicable):
rhevm-3.5.1.1-0.1

How reproducible:
Unknown

Steps to Reproduce:
1. Select a VM with no disks
2. Click the [Add] button in the Disks subtab for that VM
3. Enter size and other parameters and click [Ok]

Actual results:
Error message

Expected results:
Successful disk creation

Additional info:

Comment 1 Allie DeVolder 2015-05-21 14:11:17 UTC
The following can be found in engine.log when this occurs:
~~~
2015-05-20 07:43:40,963 INFO  [org.ovirt.engine.core.bll.ProcessOvfUpdateForStorageDomainCommand] (DefaultQuartzScheduler_Worker-80) [4ddf4eaa] Lock Acquired to object EngineLock [exclusiveLocks= key: fc368659-4bf9-4f59-844e-b1d0192c114f value: STORAGE
key: e8085f72-f91b-4fa7-8150-a14243d75c15 value: DISK
key: 166ecfba-c21b-4147-b4d6-bc378dc1e5ac value: DISK
, sharedLocks= key: 941567b0-8a4e-11e1-aff8-777f93db9152 value: OVF_UPDATE
]
2015-05-20 07:43:40,965 INFO  [org.ovirt.engine.core.bll.ProcessOvfUpdateForStorageDomainCommand] (DefaultQuartzScheduler_Worker-80) [4ddf4eaa] Running command: ProcessOvfUpdateForStorageDomainCommand internal: true. Entities affected :  ID: fc368659-4bf9-4f59-844e-b1d0192c114f Type: Storage
2015-05-20 07:43:40,977 ERROR [org.ovirt.engine.core.bll.ProcessOvfUpdateForStorageDomainCommand] (DefaultQuartzScheduler_Worker-80) [4ddf4eaa] Command org.ovirt.engine.core.bll.ProcessOvfUpdateForStorageDomainCommand throw exception: org.springframework.jdbc.BadSqlGrammarException: PreparedStatementCallback; bad SQL 
grammar [select * from  getvmsandtemplatesidswithoutattachedimagedisks()]; nested exception is org.postgresql.util.PSQLException: ERROR: function getvmsandtemplatesidswithoutattachedimagedisks() does not exist
  Hint: No function matches the given name and argument types. You might need to add explicit type casts.
  Position: 16
        at org.springframework.jdbc.support.SQLStateSQLExceptionTranslator.doTranslate(SQLStateSQLExceptionTranslator.java:98) [spring-jdbc.jar:3.1.1.RELEASE]
        at org.springframework.jdbc.support.AbstractFallbackSQLExceptionTranslator.translate(AbstractFallbackSQLExceptionTranslator.java:72) [spring-jdbc.jar:3.1.1.RELEASE]
        at org.springframework.jdbc.support.AbstractFallbackSQLExceptionTranslator.translate(AbstractFallbackSQLExceptionTranslator.java:80) [spring-jdbc.jar:3.1.1.RELEASE]
        at org.springframework.jdbc.support.AbstractFallbackSQLExceptionTranslator.translate(AbstractFallbackSQLExceptionTranslator.java:80) [spring-jdbc.jar:3.1.1.RELEASE]
        at org.springframework.jdbc.core.JdbcTemplate.execute(JdbcTemplate.java:603) [spring-jdbc.jar:3.1.1.RELEASE]
        at org.springframework.jdbc.core.JdbcTemplate.query(JdbcTemplate.java:637) [spring-jdbc.jar:3.1.1.RELEASE]
        at org.springframework.jdbc.core.JdbcTemplate.query(JdbcTemplate.java:666) [spring-jdbc.jar:3.1.1.RELEASE]
        at org.springframework.jdbc.core.JdbcTemplate.query(JdbcTemplate.java:706) [spring-jdbc.jar:3.1.1.RELEASE]
        at org.ovirt.engine.core.dal.dbbroker.PostgresDbEngineDialect$PostgresSimpleJdbcCall.executeCallInternal(PostgresDbEngineDialect.java:154) [dal.jar:]
        at org.ovirt.engine.core.dal.dbbroker.PostgresDbEngineDialect$PostgresSimpleJdbcCall.doExecute(PostgresDbEngineDialect.java:120) [dal.jar:]
        at org.springframework.jdbc.core.simple.SimpleJdbcCall.execute(SimpleJdbcCall.java:181) [spring-jdbc.jar:3.1.1.RELEASE]
        at org.ovirt.engine.core.dal.dbbroker.SimpleJdbcCallsHandler.executeImpl(SimpleJdbcCallsHandler.java:141) [dal.jar:]
        at org.ovirt.engine.core.dal.dbbroker.SimpleJdbcCallsHandler.executeReadList(SimpleJdbcCallsHandler.java:103) [dal.jar:]
        at org.ovirt.engine.core.dao.VmStaticDAODbFacadeImpl.getVmAndTemplatesIdsWithoutAttachedImageDisks(VmStaticDAODbFacadeImpl.java:65) [dal.jar:]
        at org.ovirt.engine.core.bll.ProcessOvfUpdateForStorageDomainCommand.updateOvfStoreContent(ProcessOvfUpdateForStorageDomainCommand.java:224) [bll.jar:]
        at org.ovirt.engine.core.bll.ProcessOvfUpdateForStorageDomainCommand.executeCommand(ProcessOvfUpdateForStorageDomainCommand.java:360) [bll.jar:]
        at org.ovirt.engine.core.bll.CommandBase.executeWithoutTransaction(CommandBase.java:1193) [bll.jar:]
        at org.ovirt.engine.core.bll.CommandBase.executeActionInTransactionScope(CommandBase.java:1332) [bll.jar:]
        at org.ovirt.engine.core.bll.CommandBase.runInTransaction(CommandBase.java:1957) [bll.jar:]
        at org.ovirt.engine.core.utils.transaction.TransactionSupport.executeInSuppressed(TransactionSupport.java:174) [utils.jar:]
        at org.ovirt.engine.core.utils.transaction.TransactionSupport.executeInScope(TransactionSupport.java:116) [utils.jar:]
        at org.ovirt.engine.core.bll.CommandBase.execute(CommandBase.java:1356) [bll.jar:]
        at org.ovirt.engine.core.bll.CommandBase.executeAction(CommandBase.java:353) [bll.jar:]
        at org.ovirt.engine.core.bll.Backend.runAction(Backend.java:435) [bll.jar:]
        at org.ovirt.engine.core.bll.Backend.runActionImpl(Backend.java:416) [bll.jar:]
        at org.ovirt.engine.core.bll.Backend.runInternalAction(Backend.java:365) [bll.jar:]
        at sun.reflect.GeneratedMethodAccessor170.invoke(Unknown Source) [:1.7.0_79]
        at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_79]
        at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_79]
        at org.jboss.as.ee.component.ManagedReferenceMethodInterceptor.processInvocation(ManagedReferenceMethodInterceptor.java:52) [jboss-as-ee.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.invocation.WeavedInterceptor.processInvocation(WeavedInterceptor.java:53) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ee.component.interceptors.UserInterceptorFactory$1.processInvocation(UserInterceptorFactory.java:63) [jboss-as-ee.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.invocation.InterceptorContext$Invocation.proceed(InterceptorContext.java:374) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.weld.ejb.Jsr299BindingsInterceptor.delegateInterception(Jsr299BindingsInterceptor.java:74) [jboss-as-weld.jar:7.5.0.Final-redhat-21]
        at org.jboss.as.weld.ejb.Jsr299BindingsInterceptor.doMethodInterception(Jsr299BindingsInterceptor.java:84) [jboss-as-weld.jar:7.5.0.Final-redhat-21]
        at org.jboss.as.weld.ejb.Jsr299BindingsInterceptor.processInvocation(Jsr299BindingsInterceptor.java:97) [jboss-as-weld.jar:7.5.0.Final-redhat-21]
        at org.jboss.as.ee.component.interceptors.UserInterceptorFactory$1.processInvocation(UserInterceptorFactory.java:63) [jboss-as-ee.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.invocation.WeavedInterceptor.processInvocation(WeavedInterceptor.java:53) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ee.component.interceptors.UserInterceptorFactory$1.processInvocation(UserInterceptorFactory.java:63) [jboss-as-ee.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ejb3.component.invocationmetrics.ExecutionTimeInterceptor.processInvocation(ExecutionTimeInterceptor.java:43) [jboss-as-ejb3.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.weld.ejb.EjbRequestScopeActivationInterceptor.processInvocation(EjbRequestScopeActivationInterceptor.java:93) [jboss-as-weld.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.invocation.InitialInterceptor.processInvocation(InitialInterceptor.java:21) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.invocation.ChainedInterceptor.processInvocation(ChainedInterceptor.java:61) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ee.component.interceptors.ComponentDispatcherInterceptor.processInvocation(ComponentDispatcherInterceptor.java:53) [jboss-as-ee.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ejb3.component.singleton.SingletonComponentInstanceAssociationInterceptor.processInvocation(SingletonComponentInstanceAssociationInterceptor.java:52) [jboss-as-ejb3.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ejb3.tx.CMTTxInterceptor.invokeInNoTx(CMTTxInterceptor.java:267) [jboss-as-ejb3.jar:7.5.0.Final-redhat-21]
        at org.jboss.as.ejb3.tx.CMTTxInterceptor.supports(CMTTxInterceptor.java:392) [jboss-as-ejb3.jar:7.5.0.Final-redhat-21]
        at org.jboss.as.ejb3.tx.CMTTxInterceptor.processInvocation(CMTTxInterceptor.java:247) [jboss-as-ejb3.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ejb3.component.interceptors.CurrentInvocationContextInterceptor.processInvocation(CurrentInvocationContextInterceptor.java:41) [jboss-as-ejb3.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ejb3.component.invocationmetrics.WaitTimeInterceptor.processInvocation(WaitTimeInterceptor.java:43) [jboss-as-ejb3.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ejb3.component.interceptors.ShutDownInterceptorFactory$1.processInvocation(ShutDownInterceptorFactory.java:64) [jboss-as-ejb3.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ejb3.component.interceptors.LoggingInterceptor.processInvocation(LoggingInterceptor.java:59) [jboss-as-ejb3.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ee.component.NamespaceContextInterceptor.processInvocation(NamespaceContextInterceptor.java:50) [jboss-as-ee.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ee.component.TCCLInterceptor.processInvocation(TCCLInterceptor.java:45) [jboss-as-ee.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.invocation.ChainedInterceptor.processInvocation(ChainedInterceptor.java:61) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ee.component.ViewService$View.invoke(ViewService.java:185) [jboss-as-ee.jar:7.5.0.Final-redhat-21]
        at org.jboss.as.ee.component.ViewDescription$1.processInvocation(ViewDescription.java:185) [jboss-as-ee.jar:7.5.0.Final-redhat-21]
        at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.invocation.ChainedInterceptor.processInvocation(ChainedInterceptor.java:61) [jboss-invocation.jar:1.1.2.Final-redhat-1]
        at org.jboss.as.ee.component.ProxyInvocationHandler.invoke(ProxyInvocationHandler.java:73) [jboss-as-ee.jar:7.5.0.Final-redhat-21]
        at org.ovirt.engine.core.bll.interfaces.BackendInternal$$$view6.runInternalAction(Unknown Source) [bll.jar:]
        at org.ovirt.engine.core.bll.OvfDataUpdater.performOvfUpdateForDomain(OvfDataUpdater.java:49) [bll.jar:]
        at org.ovirt.engine.core.bll.OvfDataUpdater.updateOvfData(OvfDataUpdater.java:79) [bll.jar:]
        at org.ovirt.engine.core.bll.OvfDataUpdater.ovfUpdate_timer(OvfDataUpdater.java:60) [bll.jar:]
        at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) [rt.jar:1.7.0_79]
        at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57) [rt.jar:1.7.0_79]
        at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_79]
        at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_79]
        at org.ovirt.engine.core.utils.timer.JobWrapper.execute(JobWrapper.java:60) [scheduler.jar:]
        at org.quartz.core.JobRunShell.run(JobRunShell.java:213) [quartz.jar:]
        at org.quartz.simpl.SimpleThreadPool$WorkerThread.run(SimpleThreadPool.java:557) [quartz.jar:]
Caused by: org.postgresql.util.PSQLException: ERROR: function getvmsandtemplatesidswithoutattachedimagedisks() does not exist
  Hint: No function matches the given name and argument types. You might need to add explicit type casts.
  Position: 16
        at org.postgresql.core.v3.QueryExecutorImpl.receiveErrorResponse(QueryExecutorImpl.java:2101)
        at org.postgresql.core.v3.QueryExecutorImpl.processResults(QueryExecutorImpl.java:1834)
        at org.postgresql.core.v3.QueryExecutorImpl.execute(QueryExecutorImpl.java:255)
        at org.postgresql.jdbc2.AbstractJdbc2Statement.execute(AbstractJdbc2Statement.java:510)
        at org.postgresql.jdbc2.AbstractJdbc2Statement.executeWithFlags(AbstractJdbc2Statement.java:386)
        at org.postgresql.jdbc2.AbstractJdbc2Statement.executeQuery(AbstractJdbc2Statement.java:271)
        at org.jboss.jca.adapters.jdbc.CachedPreparedStatement.executeQuery(CachedPreparedStatement.java:107)
        at org.jboss.jca.adapters.jdbc.WrappedPreparedStatement.executeQuery(WrappedPreparedStatement.java:462)
        at org.springframework.jdbc.core.JdbcTemplate$1.doInPreparedStatement(JdbcTemplate.java:644) [spring-jdbc.jar:3.1.1.RELEASE]
        at org.springframework.jdbc.core.JdbcTemplate.execute(JdbcTemplate.java:587) [spring-jdbc.jar:3.1.1.RELEASE]
        ... 82 more

2015-05-20 07:43:40,980 INFO  [org.ovirt.engine.core.bll.ProcessOvfUpdateForStorageDomainCommand] (DefaultQuartzScheduler_Worker-80) [4ddf4eaa] Lock freed to object EngineLock [exclusiveLocks= key: fc368659-4bf9-4f59-844e-b1d0192c114f value: STORAGE
key: e8085f72-f91b-4fa7-8150-a14243d75c15 value: DISK
key: 166ecfba-c21b-4147-b4d6-bc378dc1e5ac value: DISK
, sharedLocks= key: 941567b0-8a4e-11e1-aff8-777f93db9152 value: OVF_UPDATE
]~~~

Comment 2 Doron Fediuck 2015-05-25 07:45:20 UTC
Hi Allan,
this is probably related to the disk creation, and not the VM itself.

The stack trace you provided may not be related (however may deserve its
own BZ). Is this a fresh install or an upgrade?

Can you please attach relevant log files from the time you try to generate a disk?
Also, which versions are currently installed there?

Comment 5 Roy Golan 2015-06-02 06:32:16 UTC
Alan, there is a db problem here. the upgrade script (was it an upgrade?) finish
well or something of that sort happen.

first lets see if the script[1] which should have prevented this bug is installed -

 select version,state from schema_version where version = '03051220';

we can then look at the installation logs and inspect the cause of the db errors.
/var/log/ovirt-engine/setup/


[1] see Bug 1160846 - the file added is /usr/share/ovirt-enginge/dbscprits/upgrade/03_05_1220_attach_disk_profile_permission.sql

Comment 6 Paul Stauffer 2015-06-02 12:00:07 UTC
Hi; I'm the customer in question.  Yes, this installation is an upgrade; it's been upgraded incrementally over a few years from (I think) 3.0 to the current 3.5.

Yes, the script you mention is present:

$ ls -l /usr/share/ovirt-engine/dbscripts/upgrade/03_05_1220_attach_disk_profile_permission.sql
-rw-r--r--. 1 root root 2284 May  6 12:45 /usr/share/ovirt-engine/dbscripts/upgrade/03_05_1220_attach_disk_profile_permission.sql

Examining the latest log file from /var/log/ovirt-engine/setup/, I see "Running upgrade sql script" lines for everything in the dbscripts directory up through "03_05_1190...", but not for any of the subsequent "03_05_12xx.." scripts.  I'll attach that log shortly.

Oh, also Doron had asked in Comment 2 about installed versions. We should be up to date with the latest packages for RHEL 6.x.  Here's the RHEV packages installed:

$ rpm -qa "rhev*" | sort
rhev-guest-tools-iso-3.5-9.el6ev.noarch
rhevm-3.5.1.1-0.1.el6ev.noarch
rhevm-backend-3.5.1.1-0.1.el6ev.noarch
rhevm-branding-rhev-3.5.0-3.el6ev.noarch
rhevm-cli-3.5.0.5-1.el6ev.noarch
rhevm-dbscripts-3.5.1.1-0.1.el6ev.noarch
rhevm-dependencies-3.5.1-1.el6ev.noarch
rhevm-doc-3.5.0-5.el6eng.noarch
rhevm-doc-ja-JP-3.5.0-2.el6eng.noarch
rhevm-extensions-api-impl-3.5.1.1-0.1.el6ev.noarch
rhevm-image-uploader-3.5.0-4.el6ev.noarch
rhevm-iso-uploader-3.5.1-1.el6ev.noarch
rhevm-lib-3.5.1.1-0.1.el6ev.noarch
rhevm-log-collector-3.5.1-1.el6ev.noarch
rhevm-restapi-3.5.1.1-0.1.el6ev.noarch
rhevm-sdk-python-3.5.2.1-1.el6ev.noarch
rhevm-setup-3.5.1.1-0.1.el6ev.noarch
rhevm-setup-base-3.5.1.1-0.1.el6ev.noarch
rhevm-setup-plugin-ovirt-engine-3.5.1.1-0.1.el6ev.noarch
rhevm-setup-plugin-ovirt-engine-common-3.5.1.1-0.1.el6ev.noarch
rhevm-setup-plugin-websocket-proxy-3.5.1.1-0.1.el6ev.noarch
rhevm-setup-plugins-3.5.1-2.el6ev.noarch
rhevm-spice-client-x64-cab-3.5-3.el6.noarch
rhevm-spice-client-x64-msi-3.5-3.el6.noarch
rhevm-spice-client-x86-cab-3.5-3.el6.noarch
rhevm-spice-client-x86-msi-3.5-3.el6.noarch
rhevm-tools-3.5.1.1-0.1.el6ev.noarch
rhevm-userportal-3.5.1.1-0.1.el6ev.noarch
rhevm-webadmin-portal-3.5.1.1-0.1.el6ev.noarch
rhevm-websocket-proxy-3.5.1.1-0.1.el6ev.noarch

Comment 7 Paul Stauffer 2015-06-02 12:04:02 UTC
Created attachment 1033725 [details]
latest ovirt-engine-setup log file

Requested ovirt-engine-setup log file.

Comment 8 Roy Golan 2015-06-03 11:28:34 UTC
(In reply to Paul Stauffer from comment #6)
> Hi; I'm the customer in question.  Yes, this installation is an upgrade;
> it's been upgraded incrementally over a few years from (I think) 3.0 to the
> current 3.5.
> 
> Yes, the script you mention is present:
> 
> $ ls -l
> /usr/share/ovirt-engine/dbscripts/upgrade/
> 03_05_1220_attach_disk_profile_permission.sql
> -rw-r--r--. 1 root root 2284 May  6 12:45
> /usr/share/ovirt-engine/dbscripts/upgrade/
> 03_05_1220_attach_disk_profile_permission.sql
> 
> Examining the latest log file from /var/log/ovirt-engine/setup/, I see
> "Running upgrade sql script" lines for everything in the dbscripts directory
> up through "03_05_1190...", but not for any of the subsequent "03_05_12xx.."
> scripts.  I'll attach that log shortly.

Hi Paul,

so that is why thing aren't working. I'll be looking at the logs now to fully understand the reason they fail to make it to the db.

can you perform this query and share the output?
select version,state from schema_version where version = '03051220';

> 
> Oh, also Doron had asked in Comment 2 about installed versions. We should be
> up to date with the latest packages for RHEL 6.x.  Here's the RHEV packages
> installed:
> 
> $ rpm -qa "rhev*" | sort
> rhev-guest-tools-iso-3.5-9.el6ev.noarch
> rhevm-3.5.1.1-0.1.el6ev.noarch
> rhevm-backend-3.5.1.1-0.1.el6ev.noarch
> rhevm-branding-rhev-3.5.0-3.el6ev.noarch
> rhevm-cli-3.5.0.5-1.el6ev.noarch
> rhevm-dbscripts-3.5.1.1-0.1.el6ev.noarch
> rhevm-dependencies-3.5.1-1.el6ev.noarch
> rhevm-doc-3.5.0-5.el6eng.noarch
> rhevm-doc-ja-JP-3.5.0-2.el6eng.noarch
> rhevm-extensions-api-impl-3.5.1.1-0.1.el6ev.noarch
> rhevm-image-uploader-3.5.0-4.el6ev.noarch
> rhevm-iso-uploader-3.5.1-1.el6ev.noarch
> rhevm-lib-3.5.1.1-0.1.el6ev.noarch
> rhevm-log-collector-3.5.1-1.el6ev.noarch
> rhevm-restapi-3.5.1.1-0.1.el6ev.noarch
> rhevm-sdk-python-3.5.2.1-1.el6ev.noarch
> rhevm-setup-3.5.1.1-0.1.el6ev.noarch
> rhevm-setup-base-3.5.1.1-0.1.el6ev.noarch
> rhevm-setup-plugin-ovirt-engine-3.5.1.1-0.1.el6ev.noarch
> rhevm-setup-plugin-ovirt-engine-common-3.5.1.1-0.1.el6ev.noarch
> rhevm-setup-plugin-websocket-proxy-3.5.1.1-0.1.el6ev.noarch
> rhevm-setup-plugins-3.5.1-2.el6ev.noarch
> rhevm-spice-client-x64-cab-3.5-3.el6.noarch
> rhevm-spice-client-x64-msi-3.5-3.el6.noarch
> rhevm-spice-client-x86-cab-3.5-3.el6.noarch
> rhevm-spice-client-x86-msi-3.5-3.el6.noarch
> rhevm-tools-3.5.1.1-0.1.el6ev.noarch
> rhevm-userportal-3.5.1.1-0.1.el6ev.noarch
> rhevm-webadmin-portal-3.5.1.1-0.1.el6ev.noarch
> rhevm-websocket-proxy-3.5.1.1-0.1.el6ev.noarch

Comment 9 Roy Golan 2015-06-03 12:25:31 UTC
can you rerun engine-setup?

Comment 10 Roy Golan 2015-06-03 12:29:43 UTC
I suspect the engine-setup didn't run after installing the rpm. 

from the install log I see:

 [reinstall_available] package rhevm-setup-3.5.0-0.32.el6ev.noarch


so the 3.5.1 packages are installed, the new java code is in place, but the db isn't upgraded.

Comment 11 Paul Stauffer 2015-06-10 15:53:15 UTC
Sorry for the delay; I was away on vacation.  I re-ran engine-setup just now, and it seems to have solved the problem.  VM disk creation is now working as expected.  Not sure what happened here, whether something misfired with engine-setup initially, or whether we just failed to run it.

Thanks for your help tracking this down.  Looks like we're all set now.


Note You need to log in before you can comment on or make changes to this bug.