Re: [ovirt-users] Unexpected protocol mismatch with SPICE HTML5

2015-06-22 Thread Jakub Niedermertl
Hi,

SPICE in browser works for me with python-websockify-0.5.1 and either 
spice-html5-0.1.6 or -0.1.5.

Jakub

- Original Message -
 From: Michal Skrivanek michal.skriva...@redhat.com
 To: nico...@devels.es, Jakub Niedermertl jnied...@redhat.com
 Cc: users@ovirt.org (users@ovirt.org) users@ovirt.org
 Sent: Wednesday, June 17, 2015 1:35:04 PM
 Subject: Re: [ovirt-users] Unexpected protocol mismatch with SPICE HTML5
 
 
 On Jun 17, 2015, at 09:17 , nico...@devels.es wrote:
 
  Hi Michal,
  
  El 2015-06-17 07:24, Michal Skrivanek escribió:
  On Jun 17, 2015, at 08:21 , Michal Skrivanek
  michal.skriva...@redhat.com wrote:
  On Jun 16, 2015, at 12:02 , nico...@devels.es wrote:
  Hi,
  I just made a fresh install of ovirt-engine (v. 3.5.3.1-1) on a CentOS-7
  x86_64 box. My previous installation had issues with the TLS
  certificate time of issue, which was successfully fixed in this version
  (https://bugzilla.redhat.com/show_bug.cgi?id=1210486). However, when
  trying to start the SPICE HTML5 client, all I can see is the grey
  square and no activity, and when clicking on Toggle messages output,
  the error message Unexpected protocol mismatch is shown.
  Things done:
  * ovirt-guest-agent installed on the VM
  * On client side, updated browser (Firefox) to latest version (38.0) and
  /ca.crt has been imported into Firefox certs
  Regarding logs on the server side, I can see the following:
  ovirt-engine
  
  2015-06-16 10:49:29,862 INFO
  [org.ovirt.engine.core.bll.SetVmTicketCommand]
  (ajp--127.0.0.1-8702-11) [39c79276] Running command: SetVmTicketCommand
  internal: false. Entities affected :  ID:
  c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction group CONNECT_TO_VM
  with role type USER
  2015-06-16 10:49:29,917 INFO
  [org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand]
  (ajp--127.0.0.1-8702-11) [39c79276] START,
  SetVmTicketVDSCommand(HostName = ovirtengine.myorg.es, HostId =
  82fb3c43-3a4b-464e-9077-8e86dea2016b,
  vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, ticket=TgrRVYoRhC8T,
  validTime=120,m userName=user,
  userId=5d502bbb-97d6-40b5-abbf-90121cea94d5), log id: 1881c90f
  2015-06-16 10:49:29,937 INFO
  [org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand]
  (ajp--127.0.0.1-8702-11) [39c79276] FINISH, SetVmTicketVDSCommand, log
  id: 1881c90f
  2015-06-16 10:49:29,957 INFO
  [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector]
  (ajp--127.0.0.1-8702-11) [39c79276] Correlation ID: 39c79276, Call
  Stack: null, Custom Event ID: -1, Message: user user@domain initiated
  console session for VM testVM
  2015-06-16 10:49:29,987 WARN
  [org.ovirt.engine.core.dal.job.ExecutionMessageDirector]
  (ajp--127.0.0.1-8702-11) [7a71a9e4] The message key VmLogon is missing
  from bundles/ExecutionMessages
  2015-06-16 10:49:30,064 INFO  [org.ovirt.engine.core.bll.VmLogonCommand]
  (ajp--127.0.0.1-8702-11) [7a71a9e4] Running command: VmLogonCommand
  internal: false. Entities affected :  ID:
  c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction group CONNECT_TO_VM
  with role type USER
  2015-06-16 10:49:30,114 INFO
  [org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand]
  (ajp--127.0.0.1-8702-11) [7a71a9e4] START, VmLogonVDSCommand(HostName =
  ovirtengine.myorg.es, HostId = 82fb3c43-3a4b-464e-9077-8e86dea2016b,
  vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, domain=domain-authz,
  password=**, userName=user@domain), log id: 68632b24
  2015-06-16 10:49:30,120 INFO
  [org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand]
  (ajp--127.0.0.1-8702-11) [7a71a9e4] FINISH, VmLogonVDSCommand, log id:
  68632b24
  2015-06-16 10:49:30,351 INFO
  [org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand]
  (DefaultQuartzScheduler_Worker-2) START,
  GlusterVolumesListVDSCommand(HostName = kvmhost.myorg.es, HostId =
  82fb3c43-3a4b-464e-9077-8e86dea2016b), log id: 2a2a439a
  2015-06-16 10:49:30,368 INFO
  [org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand]
  (DefaultQuartzScheduler_Worker-2) FINISH, GlusterVolumesListVDSCommand,
  return: {}, log id: 2a2a439a
  ovirt-websocket-proxy
  =
  jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]:
  10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: SSL/TLS (wss://)
  WebSocket connection
  jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]:
  10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Version hybi-13, base64:
  'False'
  jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]:
  10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Path:
  '/eyJ2YWxpZFRvIjoiMjAxNTA2MTYwODU4MzgiLCJkYXRhIjoiJTdCJTIyaG9zdCUyMjolMjIxMC4xMDcuMjYuMjAxJTIyLCUyMnBvcnQlMjI6JTIyNTkwMCUyMiwlMjJzc2xfdGFyZ2V0JTIyOnRydWUlN0QiLCJ2YWxpZEZyb20iOiIyMDE1MDYxNjA4NTYzOCIsInNpZ25lZEZpZWxkcyI6InZhbGlkVG8sZGF0YSx2YWxpZEZyb20sc2FsdCI

Re: [ovirt-users] Unexpected protocol mismatch with SPICE HTML5

2015-06-18 Thread Michal Skrivanek

On Jun 17, 2015, at 14:24 , nico...@devels.es wrote:

 El 2015-06-17 12:35, Michal Skrivanek escribió:
 On Jun 17, 2015, at 09:17 , nico...@devels.es wrote:
 Hi Michal,
 El 2015-06-17 07:24, Michal Skrivanek escribió:
 On Jun 17, 2015, at 08:21 , Michal Skrivanek
 michal.skriva...@redhat.com wrote:
 On Jun 16, 2015, at 12:02 , nico...@devels.es wrote:
 Hi,
 I just made a fresh install of ovirt-engine (v. 3.5.3.1-1) on a CentOS-7 
 x86_64 box. My previous installation had issues with the TLS certificate 
 time of issue, which was successfully fixed in this version 
 (https://bugzilla.redhat.com/show_bug.cgi?id=1210486). However, when 
 trying to start the SPICE HTML5 client, all I can see is the grey square 
 and no activity, and when clicking on Toggle messages output, the 
 error message Unexpected protocol mismatch is shown.
 Things done:
 * ovirt-guest-agent installed on the VM
 * On client side, updated browser (Firefox) to latest version (38.0) and 
 /ca.crt has been imported into Firefox certs
 Regarding logs on the server side, I can see the following:
 ovirt-engine
 
 2015-06-16 10:49:29,862 INFO  
 [org.ovirt.engine.core.bll.SetVmTicketCommand] (ajp--127.0.0.1-8702-11) 
 [39c79276] Running command: SetVmTicketCommand internal: false. Entities 
 affected :  ID: c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction 
 group CONNECT_TO_VM with role type USER
 2015-06-16 10:49:29,917 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
 (ajp--127.0.0.1-8702-11) [39c79276] START, 
 SetVmTicketVDSCommand(HostName = ovirtengine.myorg.es, HostId = 
 82fb3c43-3a4b-464e-9077-8e86dea2016b, 
 vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, ticket=TgrRVYoRhC8T, 
 validTime=120,m userName=user, 
 userId=5d502bbb-97d6-40b5-abbf-90121cea94d5), log id: 1881c90f
 2015-06-16 10:49:29,937 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
 (ajp--127.0.0.1-8702-11) [39c79276] FINISH, SetVmTicketVDSCommand, log 
 id: 1881c90f
 2015-06-16 10:49:29,957 INFO  
 [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] 
 (ajp--127.0.0.1-8702-11) [39c79276] Correlation ID: 39c79276, Call 
 Stack: null, Custom Event ID: -1, Message: user user@domain initiated 
 console session for VM testVM
 2015-06-16 10:49:29,987 WARN  
 [org.ovirt.engine.core.dal.job.ExecutionMessageDirector] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] The message key VmLogon is missing 
 from bundles/ExecutionMessages
 2015-06-16 10:49:30,064 INFO  [org.ovirt.engine.core.bll.VmLogonCommand] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] Running command: VmLogonCommand 
 internal: false. Entities affected :  ID: 
 c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction group CONNECT_TO_VM 
 with role type USER
 2015-06-16 10:49:30,114 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] START, VmLogonVDSCommand(HostName = 
 ovirtengine.myorg.es, HostId = 82fb3c43-3a4b-464e-9077-8e86dea2016b, 
 vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, domain=domain-authz, 
 password=**, userName=user@domain), log id: 68632b24
 2015-06-16 10:49:30,120 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] FINISH, VmLogonVDSCommand, log id: 
 68632b24
 2015-06-16 10:49:30,351 INFO  
 [org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
 (DefaultQuartzScheduler_Worker-2) START, 
 GlusterVolumesListVDSCommand(HostName = kvmhost.myorg.es, HostId = 
 82fb3c43-3a4b-464e-9077-8e86dea2016b), log id: 2a2a439a
 2015-06-16 10:49:30,368 INFO  
 [org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
 (DefaultQuartzScheduler_Worker-2) FINISH, GlusterVolumesListVDSCommand, 
 return: {}, log id: 2a2a439a
 ovirt-websocket-proxy
 =
 jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
 10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: SSL/TLS (wss://) WebSocket 
 connection
 jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
 10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Version hybi-13, base64: 
 'False'
 jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
 10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Path: 
 

Re: [ovirt-users] Unexpected protocol mismatch with SPICE HTML5

2015-06-17 Thread nicolas

El 2015-06-17 12:35, Michal Skrivanek escribió:

On Jun 17, 2015, at 09:17 , nico...@devels.es wrote:


Hi Michal,

El 2015-06-17 07:24, Michal Skrivanek escribió:

On Jun 17, 2015, at 08:21 , Michal Skrivanek
michal.skriva...@redhat.com wrote:

On Jun 16, 2015, at 12:02 , nico...@devels.es wrote:

Hi,
I just made a fresh install of ovirt-engine (v. 3.5.3.1-1) on a 
CentOS-7 x86_64 box. My previous installation had issues with the 
TLS certificate time of issue, which was successfully fixed in this 
version (https://bugzilla.redhat.com/show_bug.cgi?id=1210486). 
However, when trying to start the SPICE HTML5 client, all I can see 
is the grey square and no activity, and when clicking on Toggle 
messages output, the error message Unexpected protocol mismatch 
is shown.

Things done:
* ovirt-guest-agent installed on the VM
* On client side, updated browser (Firefox) to latest version 
(38.0) and /ca.crt has been imported into Firefox certs

Regarding logs on the server side, I can see the following:
ovirt-engine

2015-06-16 10:49:29,862 INFO  
[org.ovirt.engine.core.bll.SetVmTicketCommand] 
(ajp--127.0.0.1-8702-11) [39c79276] Running command: 
SetVmTicketCommand internal: false. Entities affected :  ID: 
c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction group 
CONNECT_TO_VM with role type USER
2015-06-16 10:49:29,917 INFO  
[org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
(ajp--127.0.0.1-8702-11) [39c79276] START, 
SetVmTicketVDSCommand(HostName = ovirtengine.myorg.es, HostId = 
82fb3c43-3a4b-464e-9077-8e86dea2016b, 
vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, ticket=TgrRVYoRhC8T, 
validTime=120,m userName=user, 
userId=5d502bbb-97d6-40b5-abbf-90121cea94d5), log id: 1881c90f
2015-06-16 10:49:29,937 INFO  
[org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
(ajp--127.0.0.1-8702-11) [39c79276] FINISH, SetVmTicketVDSCommand, 
log id: 1881c90f
2015-06-16 10:49:29,957 INFO  
[org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] 
(ajp--127.0.0.1-8702-11) [39c79276] Correlation ID: 39c79276, Call 
Stack: null, Custom Event ID: -1, Message: user user@domain 
initiated console session for VM testVM
2015-06-16 10:49:29,987 WARN  
[org.ovirt.engine.core.dal.job.ExecutionMessageDirector] 
(ajp--127.0.0.1-8702-11) [7a71a9e4] The message key VmLogon is 
missing from bundles/ExecutionMessages
2015-06-16 10:49:30,064 INFO  
[org.ovirt.engine.core.bll.VmLogonCommand] (ajp--127.0.0.1-8702-11) 
[7a71a9e4] Running command: VmLogonCommand internal: false. 
Entities affected :  ID: c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: 
VMAction group CONNECT_TO_VM with role type USER
2015-06-16 10:49:30,114 INFO  
[org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
(ajp--127.0.0.1-8702-11) [7a71a9e4] START, 
VmLogonVDSCommand(HostName = ovirtengine.myorg.es, HostId = 
82fb3c43-3a4b-464e-9077-8e86dea2016b, 
vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, domain=domain-authz, 
password=**, userName=user@domain), log id: 68632b24
2015-06-16 10:49:30,120 INFO  
[org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
(ajp--127.0.0.1-8702-11) [7a71a9e4] FINISH, VmLogonVDSCommand, log 
id: 68632b24
2015-06-16 10:49:30,351 INFO  
[org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
(DefaultQuartzScheduler_Worker-2) START, 
GlusterVolumesListVDSCommand(HostName = kvmhost.myorg.es, HostId = 
82fb3c43-3a4b-464e-9077-8e86dea2016b), log id: 2a2a439a
2015-06-16 10:49:30,368 INFO  
[org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
(DefaultQuartzScheduler_Worker-2) FINISH, 
GlusterVolumesListVDSCommand, return: {}, log id: 2a2a439a

ovirt-websocket-proxy
=
jun 16 09:56:39 ovirtengine.myorg.es 
ovirt-websocket-proxy.py[30728]: 10.X.X.X - - [16/Jun/2015 
09:56:39] 10.X.X.X: SSL/TLS (wss://) WebSocket connection
jun 16 09:56:39 ovirtengine.myorg.es 
ovirt-websocket-proxy.py[30728]: 10.X.X.X - - [16/Jun/2015 
09:56:39] 10.X.X.X: Version hybi-13, base64: 'False'
jun 16 09:56:39 ovirtengine.myorg.es 
ovirt-websocket-proxy.py[30728]: 10.X.X.X - - [16/Jun/2015 
09:56:39] 10.X.X.X: Path: 
'/eyJ2YWxpZFRvIjoiMjAxNTA2MTYwODU4MzgiLCJkYXRhIjoiJTdCJTIyaG9zdCUyMjolMjIxMC4xMDcuMjYuMjAxJTIyLCUyMnBvcnQlMjI6JTIyNTkwMCUyMiwlMjJzc2xfdGFyZ2V0JTIyOnRydWUlN0QiLCJ2YWxpZEZyb20iOiIyMDE1MDYxNjA4NTYzOCIsInNpZ25lZEZpZWxkcyI6InZhbGlkVG8sZGF0YSx2YWxpZEZyb20sc2FsdCIsInNpZ25hdHVyZSI6Imk2a3J2bjFCLzFYbUptSEJjVVZZRWVhSExwenA1LzJBQU1DWmJZcDJsaE9heEYvdkZ3azJIa0hibm5iY21mZFp3STJYbnFzMm9vZnMvNWV3NlNiTGtGeTdaVVdjZG4zdUxTcStZTVg4c3huUzg0Ulg3ZmtLTk05Mk9CeFJENm5VSEVDMXQ1eld0OXo3akZYVktMdXFEYkNiK3RmL3pNZGJuS0ZCcGtXaU5JVVB4b09yd2ZxRUQxMWZTell0aXVFeEFscW5xWlBqSXpjcHNDTHRwQXZaTnNWWWFNQlFWR1U2WnZiZlFWUTBlaFIzMnVyaTlVUmI1NDZCZVBuMkVJdytwU3RIWmZRWit2RDZKUjRWeDJFSFRqVEtXZ2ZMbzRWY0ZjSzNnQURYV1BKbUJjaWx5TExQR3dnTm1ncEk0cjVhR1ZCTmZ1VVUxSENJTlhWUVZPVnJJZz09Iiwic2FsdCI6IndFZGwvcmw3VWZJPSJ9'

Java console

 disconnect spicehtml5-main.html:86:16
 disconnect 

Re: [ovirt-users] Unexpected protocol mismatch with SPICE HTML5

2015-06-17 Thread Michal Skrivanek

On Jun 17, 2015, at 09:17 , nico...@devels.es wrote:

 Hi Michal,
 
 El 2015-06-17 07:24, Michal Skrivanek escribió:
 On Jun 17, 2015, at 08:21 , Michal Skrivanek
 michal.skriva...@redhat.com wrote:
 On Jun 16, 2015, at 12:02 , nico...@devels.es wrote:
 Hi,
 I just made a fresh install of ovirt-engine (v. 3.5.3.1-1) on a CentOS-7 
 x86_64 box. My previous installation had issues with the TLS certificate 
 time of issue, which was successfully fixed in this version 
 (https://bugzilla.redhat.com/show_bug.cgi?id=1210486). However, when 
 trying to start the SPICE HTML5 client, all I can see is the grey square 
 and no activity, and when clicking on Toggle messages output, the error 
 message Unexpected protocol mismatch is shown.
 Things done:
 * ovirt-guest-agent installed on the VM
 * On client side, updated browser (Firefox) to latest version (38.0) and 
 /ca.crt has been imported into Firefox certs
 Regarding logs on the server side, I can see the following:
 ovirt-engine
 
 2015-06-16 10:49:29,862 INFO  
 [org.ovirt.engine.core.bll.SetVmTicketCommand] (ajp--127.0.0.1-8702-11) 
 [39c79276] Running command: SetVmTicketCommand internal: false. Entities 
 affected :  ID: c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction group 
 CONNECT_TO_VM with role type USER
 2015-06-16 10:49:29,917 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
 (ajp--127.0.0.1-8702-11) [39c79276] START, SetVmTicketVDSCommand(HostName 
 = ovirtengine.myorg.es, HostId = 82fb3c43-3a4b-464e-9077-8e86dea2016b, 
 vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, ticket=TgrRVYoRhC8T, 
 validTime=120,m userName=user, 
 userId=5d502bbb-97d6-40b5-abbf-90121cea94d5), log id: 1881c90f
 2015-06-16 10:49:29,937 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
 (ajp--127.0.0.1-8702-11) [39c79276] FINISH, SetVmTicketVDSCommand, log id: 
 1881c90f
 2015-06-16 10:49:29,957 INFO  
 [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] 
 (ajp--127.0.0.1-8702-11) [39c79276] Correlation ID: 39c79276, Call Stack: 
 null, Custom Event ID: -1, Message: user user@domain initiated console 
 session for VM testVM
 2015-06-16 10:49:29,987 WARN  
 [org.ovirt.engine.core.dal.job.ExecutionMessageDirector] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] The message key VmLogon is missing 
 from bundles/ExecutionMessages
 2015-06-16 10:49:30,064 INFO  [org.ovirt.engine.core.bll.VmLogonCommand] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] Running command: VmLogonCommand 
 internal: false. Entities affected :  ID: 
 c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction group CONNECT_TO_VM 
 with role type USER
 2015-06-16 10:49:30,114 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] START, VmLogonVDSCommand(HostName = 
 ovirtengine.myorg.es, HostId = 82fb3c43-3a4b-464e-9077-8e86dea2016b, 
 vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, domain=domain-authz, 
 password=**, userName=user@domain), log id: 68632b24
 2015-06-16 10:49:30,120 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] FINISH, VmLogonVDSCommand, log id: 
 68632b24
 2015-06-16 10:49:30,351 INFO  
 [org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
 (DefaultQuartzScheduler_Worker-2) START, 
 GlusterVolumesListVDSCommand(HostName = kvmhost.myorg.es, HostId = 
 82fb3c43-3a4b-464e-9077-8e86dea2016b), log id: 2a2a439a
 2015-06-16 10:49:30,368 INFO  
 [org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
 (DefaultQuartzScheduler_Worker-2) FINISH, GlusterVolumesListVDSCommand, 
 return: {}, log id: 2a2a439a
 ovirt-websocket-proxy
 =
 jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
 10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: SSL/TLS (wss://) WebSocket 
 connection
 jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
 10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Version hybi-13, base64: 
 'False'
 jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
 10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Path: 
 '/eyJ2YWxpZFRvIjoiMjAxNTA2MTYwODU4MzgiLCJkYXRhIjoiJTdCJTIyaG9zdCUyMjolMjIxMC4xMDcuMjYuMjAxJTIyLCUyMnBvcnQlMjI6JTIyNTkwMCUyMiwlMjJzc2xfdGFyZ2V0JTIyOnRydWUlN0QiLCJ2YWxpZEZyb20iOiIyMDE1MDYxNjA4NTYzOCIsInNpZ25lZEZpZWxkcyI6InZhbGlkVG8sZGF0YSx2YWxpZEZyb20sc2FsdCIsInNpZ25hdHVyZSI6Imk2a3J2bjFCLzFYbUptSEJjVVZZRWVhSExwenA1LzJBQU1DWmJZcDJsaE9heEYvdkZ3azJIa0hibm5iY21mZFp3STJYbnFzMm9vZnMvNWV3NlNiTGtGeTdaVVdjZG4zdUxTcStZTVg4c3huUzg0Ulg3ZmtLTk05Mk9CeFJENm5VSEVDMXQ1eld0OXo3akZYVktMdXFEYkNiK3RmL3pNZGJuS0ZCcGtXaU5JVVB4b09yd2ZxRUQxMWZTell0aXVFeEFscW5xWlBqSXpjcHNDTHRwQXZaTnNWWWFNQlFWR1U2WnZiZlFWUTBlaFIzMnVyaTlVUmI1NDZCZVBuMkVJdytwU3RIWmZRWit2RDZKUjRWeDJFSFRqVEtXZ2ZMbzRWY0ZjSzNnQURYV1BKbUJjaWx5TExQR3dnTm1ncEk0cjVhR1ZCTmZ1VVUxSENJTlhWUVZPVnJJZz09Iiwic2FsdCI6IndFZGwvcmw3VWZJPSJ9'
 Java console
 
  disconnect 

Re: [ovirt-users] Unexpected protocol mismatch with SPICE HTML5

2015-06-17 Thread Michal Skrivanek

On Jun 16, 2015, at 12:02 , nico...@devels.es wrote:

 Hi,
 
 I just made a fresh install of ovirt-engine (v. 3.5.3.1-1) on a CentOS-7 
 x86_64 box. My previous installation had issues with the TLS certificate time 
 of issue, which was successfully fixed in this version 
 (https://bugzilla.redhat.com/show_bug.cgi?id=1210486). However, when trying 
 to start the SPICE HTML5 client, all I can see is the grey square and no 
 activity, and when clicking on Toggle messages output, the error message 
 Unexpected protocol mismatch is shown.
 
 Things done:
 * ovirt-guest-agent installed on the VM
 * On client side, updated browser (Firefox) to latest version (38.0) and 
 /ca.crt has been imported into Firefox certs
 
 Regarding logs on the server side, I can see the following:
 
 ovirt-engine
 
 
 2015-06-16 10:49:29,862 INFO  [org.ovirt.engine.core.bll.SetVmTicketCommand] 
 (ajp--127.0.0.1-8702-11) [39c79276] Running command: SetVmTicketCommand 
 internal: false. Entities affected :  ID: 
 c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction group CONNECT_TO_VM with 
 role type USER
 2015-06-16 10:49:29,917 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
 (ajp--127.0.0.1-8702-11) [39c79276] START, SetVmTicketVDSCommand(HostName = 
 ovirtengine.myorg.es, HostId = 82fb3c43-3a4b-464e-9077-8e86dea2016b, 
 vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, ticket=TgrRVYoRhC8T, 
 validTime=120,m userName=user, userId=5d502bbb-97d6-40b5-abbf-90121cea94d5), 
 log id: 1881c90f
 2015-06-16 10:49:29,937 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
 (ajp--127.0.0.1-8702-11) [39c79276] FINISH, SetVmTicketVDSCommand, log id: 
 1881c90f
 2015-06-16 10:49:29,957 INFO  
 [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] 
 (ajp--127.0.0.1-8702-11) [39c79276] Correlation ID: 39c79276, Call Stack: 
 null, Custom Event ID: -1, Message: user user@domain initiated console 
 session for VM testVM
 2015-06-16 10:49:29,987 WARN  
 [org.ovirt.engine.core.dal.job.ExecutionMessageDirector] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] The message key VmLogon is missing from 
 bundles/ExecutionMessages
 2015-06-16 10:49:30,064 INFO  [org.ovirt.engine.core.bll.VmLogonCommand] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] Running command: VmLogonCommand internal: 
 false. Entities affected :  ID: c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: 
 VMAction group CONNECT_TO_VM with role type USER
 2015-06-16 10:49:30,114 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] START, VmLogonVDSCommand(HostName = 
 ovirtengine.myorg.es, HostId = 82fb3c43-3a4b-464e-9077-8e86dea2016b, 
 vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, domain=domain-authz, 
 password=**, userName=user@domain), log id: 68632b24
 2015-06-16 10:49:30,120 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] FINISH, VmLogonVDSCommand, log id: 
 68632b24
 2015-06-16 10:49:30,351 INFO  
 [org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
 (DefaultQuartzScheduler_Worker-2) START, 
 GlusterVolumesListVDSCommand(HostName = kvmhost.myorg.es, HostId = 
 82fb3c43-3a4b-464e-9077-8e86dea2016b), log id: 2a2a439a
 2015-06-16 10:49:30,368 INFO  
 [org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
 (DefaultQuartzScheduler_Worker-2) FINISH, GlusterVolumesListVDSCommand, 
 return: {}, log id: 2a2a439a
 
 ovirt-websocket-proxy
 =
 
 jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
 10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: SSL/TLS (wss://) WebSocket 
 connection
 jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
 10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Version hybi-13, base64: 'False'
 jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
 10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Path: 
 '/eyJ2YWxpZFRvIjoiMjAxNTA2MTYwODU4MzgiLCJkYXRhIjoiJTdCJTIyaG9zdCUyMjolMjIxMC4xMDcuMjYuMjAxJTIyLCUyMnBvcnQlMjI6JTIyNTkwMCUyMiwlMjJzc2xfdGFyZ2V0JTIyOnRydWUlN0QiLCJ2YWxpZEZyb20iOiIyMDE1MDYxNjA4NTYzOCIsInNpZ25lZEZpZWxkcyI6InZhbGlkVG8sZGF0YSx2YWxpZEZyb20sc2FsdCIsInNpZ25hdHVyZSI6Imk2a3J2bjFCLzFYbUptSEJjVVZZRWVhSExwenA1LzJBQU1DWmJZcDJsaE9heEYvdkZ3azJIa0hibm5iY21mZFp3STJYbnFzMm9vZnMvNWV3NlNiTGtGeTdaVVdjZG4zdUxTcStZTVg4c3huUzg0Ulg3ZmtLTk05Mk9CeFJENm5VSEVDMXQ1eld0OXo3akZYVktMdXFEYkNiK3RmL3pNZGJuS0ZCcGtXaU5JVVB4b09yd2ZxRUQxMWZTell0aXVFeEFscW5xWlBqSXpjcHNDTHRwQXZaTnNWWWFNQlFWR1U2WnZiZlFWUTBlaFIzMnVyaTlVUmI1NDZCZVBuMkVJdytwU3RIWmZRWit2RDZKUjRWeDJFSFRqVEtXZ2ZMbzRWY0ZjSzNnQURYV1BKbUJjaWx5TExQR3dnTm1ncEk0cjVhR1ZCTmZ1VVUxSENJTlhWUVZPVnJJZz09Iiwic2FsdCI6IndFZGwvcmw3VWZJPSJ9'
 
 Java console
 
 
  disconnect spicehtml5-main.html:86:16
  disconnect spicehtml5-main.html:90:16
 ERROR: Error: Unexpected protocol mismatch.
 
 -
 
 
 I can't see any other relevant info, so I wonder if something else 

Re: [ovirt-users] Unexpected protocol mismatch with SPICE HTML5

2015-06-17 Thread nicolas

Hi Michal,

El 2015-06-17 07:24, Michal Skrivanek escribió:

On Jun 17, 2015, at 08:21 , Michal Skrivanek
michal.skriva...@redhat.com wrote:



On Jun 16, 2015, at 12:02 , nico...@devels.es wrote:


Hi,

I just made a fresh install of ovirt-engine (v. 3.5.3.1-1) on a 
CentOS-7 x86_64 box. My previous installation had issues with the TLS 
certificate time of issue, which was successfully fixed in this 
version (https://bugzilla.redhat.com/show_bug.cgi?id=1210486). 
However, when trying to start the SPICE HTML5 client, all I can see 
is the grey square and no activity, and when clicking on Toggle 
messages output, the error message Unexpected protocol mismatch is 
shown.


Things done:
* ovirt-guest-agent installed on the VM
* On client side, updated browser (Firefox) to latest version (38.0) 
and /ca.crt has been imported into Firefox certs


Regarding logs on the server side, I can see the following:

ovirt-engine


2015-06-16 10:49:29,862 INFO  
[org.ovirt.engine.core.bll.SetVmTicketCommand] 
(ajp--127.0.0.1-8702-11) [39c79276] Running command: 
SetVmTicketCommand internal: false. Entities affected :  ID: 
c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction group 
CONNECT_TO_VM with role type USER
2015-06-16 10:49:29,917 INFO  
[org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
(ajp--127.0.0.1-8702-11) [39c79276] START, 
SetVmTicketVDSCommand(HostName = ovirtengine.myorg.es, HostId = 
82fb3c43-3a4b-464e-9077-8e86dea2016b, 
vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, ticket=TgrRVYoRhC8T, 
validTime=120,m userName=user, 
userId=5d502bbb-97d6-40b5-abbf-90121cea94d5), log id: 1881c90f
2015-06-16 10:49:29,937 INFO  
[org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
(ajp--127.0.0.1-8702-11) [39c79276] FINISH, SetVmTicketVDSCommand, 
log id: 1881c90f
2015-06-16 10:49:29,957 INFO  
[org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] 
(ajp--127.0.0.1-8702-11) [39c79276] Correlation ID: 39c79276, Call 
Stack: null, Custom Event ID: -1, Message: user user@domain initiated 
console session for VM testVM
2015-06-16 10:49:29,987 WARN  
[org.ovirt.engine.core.dal.job.ExecutionMessageDirector] 
(ajp--127.0.0.1-8702-11) [7a71a9e4] The message key VmLogon is 
missing from bundles/ExecutionMessages
2015-06-16 10:49:30,064 INFO  
[org.ovirt.engine.core.bll.VmLogonCommand] (ajp--127.0.0.1-8702-11) 
[7a71a9e4] Running command: VmLogonCommand internal: false. Entities 
affected :  ID: c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction 
group CONNECT_TO_VM with role type USER
2015-06-16 10:49:30,114 INFO  
[org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
(ajp--127.0.0.1-8702-11) [7a71a9e4] START, VmLogonVDSCommand(HostName 
= ovirtengine.myorg.es, HostId = 
82fb3c43-3a4b-464e-9077-8e86dea2016b, 
vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, domain=domain-authz, 
password=**, userName=user@domain), log id: 68632b24
2015-06-16 10:49:30,120 INFO  
[org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
(ajp--127.0.0.1-8702-11) [7a71a9e4] FINISH, VmLogonVDSCommand, log 
id: 68632b24
2015-06-16 10:49:30,351 INFO  
[org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
(DefaultQuartzScheduler_Worker-2) START, 
GlusterVolumesListVDSCommand(HostName = kvmhost.myorg.es, HostId = 
82fb3c43-3a4b-464e-9077-8e86dea2016b), log id: 2a2a439a
2015-06-16 10:49:30,368 INFO  
[org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
(DefaultQuartzScheduler_Worker-2) FINISH, 
GlusterVolumesListVDSCommand, return: {}, log id: 2a2a439a


ovirt-websocket-proxy
=

jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: SSL/TLS (wss://) 
WebSocket connection
jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Version hybi-13, 
base64: 'False'
jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Path: 
'/eyJ2YWxpZFRvIjoiMjAxNTA2MTYwODU4MzgiLCJkYXRhIjoiJTdCJTIyaG9zdCUyMjolMjIxMC4xMDcuMjYuMjAxJTIyLCUyMnBvcnQlMjI6JTIyNTkwMCUyMiwlMjJzc2xfdGFyZ2V0JTIyOnRydWUlN0QiLCJ2YWxpZEZyb20iOiIyMDE1MDYxNjA4NTYzOCIsInNpZ25lZEZpZWxkcyI6InZhbGlkVG8sZGF0YSx2YWxpZEZyb20sc2FsdCIsInNpZ25hdHVyZSI6Imk2a3J2bjFCLzFYbUptSEJjVVZZRWVhSExwenA1LzJBQU1DWmJZcDJsaE9heEYvdkZ3azJIa0hibm5iY21mZFp3STJYbnFzMm9vZnMvNWV3NlNiTGtGeTdaVVdjZG4zdUxTcStZTVg4c3huUzg0Ulg3ZmtLTk05Mk9CeFJENm5VSEVDMXQ1eld0OXo3akZYVktMdXFEYkNiK3RmL3pNZGJuS0ZCcGtXaU5JVVB4b09yd2ZxRUQxMWZTell0aXVFeEFscW5xWlBqSXpjcHNDTHRwQXZaTnNWWWFNQlFWR1U2WnZiZlFWUTBlaFIzMnVyaTlVUmI1NDZCZVBuMkVJdytwU3RIWmZRWit2RDZKUjRWeDJFSFRqVEtXZ2ZMbzRWY0ZjSzNnQURYV1BKbUJjaWx5TExQR3dnTm1ncEk0cjVhR1ZCTmZ1VVUxSENJTlhWUVZPVnJJZz09Iiwic2FsdCI6IndFZGwvcmw3VWZJPSJ9'


Java console


 disconnect spicehtml5-main.html:86:16
 disconnect spicehtml5-main.html:90:16
ERROR: Error: Unexpected protocol mismatch.

-


I can't 

Re: [ovirt-users] Unexpected protocol mismatch with SPICE HTML5

2015-06-17 Thread Michal Skrivanek

On Jun 17, 2015, at 08:21 , Michal Skrivanek michal.skriva...@redhat.com 
wrote:

 
 On Jun 16, 2015, at 12:02 , nico...@devels.es wrote:
 
 Hi,
 
 I just made a fresh install of ovirt-engine (v. 3.5.3.1-1) on a CentOS-7 
 x86_64 box. My previous installation had issues with the TLS certificate 
 time of issue, which was successfully fixed in this version 
 (https://bugzilla.redhat.com/show_bug.cgi?id=1210486). However, when trying 
 to start the SPICE HTML5 client, all I can see is the grey square and no 
 activity, and when clicking on Toggle messages output, the error message 
 Unexpected protocol mismatch is shown.
 
 Things done:
 * ovirt-guest-agent installed on the VM
 * On client side, updated browser (Firefox) to latest version (38.0) and 
 /ca.crt has been imported into Firefox certs
 
 Regarding logs on the server side, I can see the following:
 
 ovirt-engine
 
 
 2015-06-16 10:49:29,862 INFO  [org.ovirt.engine.core.bll.SetVmTicketCommand] 
 (ajp--127.0.0.1-8702-11) [39c79276] Running command: SetVmTicketCommand 
 internal: false. Entities affected :  ID: 
 c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction group CONNECT_TO_VM with 
 role type USER
 2015-06-16 10:49:29,917 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
 (ajp--127.0.0.1-8702-11) [39c79276] START, SetVmTicketVDSCommand(HostName = 
 ovirtengine.myorg.es, HostId = 82fb3c43-3a4b-464e-9077-8e86dea2016b, 
 vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, ticket=TgrRVYoRhC8T, 
 validTime=120,m userName=user, userId=5d502bbb-97d6-40b5-abbf-90121cea94d5), 
 log id: 1881c90f
 2015-06-16 10:49:29,937 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
 (ajp--127.0.0.1-8702-11) [39c79276] FINISH, SetVmTicketVDSCommand, log id: 
 1881c90f
 2015-06-16 10:49:29,957 INFO  
 [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] 
 (ajp--127.0.0.1-8702-11) [39c79276] Correlation ID: 39c79276, Call Stack: 
 null, Custom Event ID: -1, Message: user user@domain initiated console 
 session for VM testVM
 2015-06-16 10:49:29,987 WARN  
 [org.ovirt.engine.core.dal.job.ExecutionMessageDirector] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] The message key VmLogon is missing from 
 bundles/ExecutionMessages
 2015-06-16 10:49:30,064 INFO  [org.ovirt.engine.core.bll.VmLogonCommand] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] Running command: VmLogonCommand 
 internal: false. Entities affected :  ID: 
 c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction group CONNECT_TO_VM with 
 role type USER
 2015-06-16 10:49:30,114 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] START, VmLogonVDSCommand(HostName = 
 ovirtengine.myorg.es, HostId = 82fb3c43-3a4b-464e-9077-8e86dea2016b, 
 vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, domain=domain-authz, 
 password=**, userName=user@domain), log id: 68632b24
 2015-06-16 10:49:30,120 INFO  
 [org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
 (ajp--127.0.0.1-8702-11) [7a71a9e4] FINISH, VmLogonVDSCommand, log id: 
 68632b24
 2015-06-16 10:49:30,351 INFO  
 [org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
 (DefaultQuartzScheduler_Worker-2) START, 
 GlusterVolumesListVDSCommand(HostName = kvmhost.myorg.es, HostId = 
 82fb3c43-3a4b-464e-9077-8e86dea2016b), log id: 2a2a439a
 2015-06-16 10:49:30,368 INFO  
 [org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
 (DefaultQuartzScheduler_Worker-2) FINISH, GlusterVolumesListVDSCommand, 
 return: {}, log id: 2a2a439a
 
 ovirt-websocket-proxy
 =
 
 jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
 10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: SSL/TLS (wss://) WebSocket 
 connection
 jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
 10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Version hybi-13, base64: 
 'False'
 jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
 10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Path: 
 '/eyJ2YWxpZFRvIjoiMjAxNTA2MTYwODU4MzgiLCJkYXRhIjoiJTdCJTIyaG9zdCUyMjolMjIxMC4xMDcuMjYuMjAxJTIyLCUyMnBvcnQlMjI6JTIyNTkwMCUyMiwlMjJzc2xfdGFyZ2V0JTIyOnRydWUlN0QiLCJ2YWxpZEZyb20iOiIyMDE1MDYxNjA4NTYzOCIsInNpZ25lZEZpZWxkcyI6InZhbGlkVG8sZGF0YSx2YWxpZEZyb20sc2FsdCIsInNpZ25hdHVyZSI6Imk2a3J2bjFCLzFYbUptSEJjVVZZRWVhSExwenA1LzJBQU1DWmJZcDJsaE9heEYvdkZ3azJIa0hibm5iY21mZFp3STJYbnFzMm9vZnMvNWV3NlNiTGtGeTdaVVdjZG4zdUxTcStZTVg4c3huUzg0Ulg3ZmtLTk05Mk9CeFJENm5VSEVDMXQ1eld0OXo3akZYVktMdXFEYkNiK3RmL3pNZGJuS0ZCcGtXaU5JVVB4b09yd2ZxRUQxMWZTell0aXVFeEFscW5xWlBqSXpjcHNDTHRwQXZaTnNWWWFNQlFWR1U2WnZiZlFWUTBlaFIzMnVyaTlVUmI1NDZCZVBuMkVJdytwU3RIWmZRWit2RDZKUjRWeDJFSFRqVEtXZ2ZMbzRWY0ZjSzNnQURYV1BKbUJjaWx5TExQR3dnTm1ncEk0cjVhR1ZCTmZ1VVUxSENJTlhWUVZPVnJJZz09Iiwic2FsdCI6IndFZGwvcmw3VWZJPSJ9'
 
 Java console
 
 
  disconnect spicehtml5-main.html:86:16
  disconnect spicehtml5-main.html:90:16
 ERROR: Error: Unexpected protocol mismatch.
 
 

[ovirt-users] Unexpected protocol mismatch with SPICE HTML5

2015-06-16 Thread nicolas

Hi,

I just made a fresh install of ovirt-engine (v. 3.5.3.1-1) on a CentOS-7 
x86_64 box. My previous installation had issues with the TLS certificate 
time of issue, which was successfully fixed in this version 
(https://bugzilla.redhat.com/show_bug.cgi?id=1210486). However, when 
trying to start the SPICE HTML5 client, all I can see is the grey square 
and no activity, and when clicking on Toggle messages output, the 
error message Unexpected protocol mismatch is shown.


Things done:
* ovirt-guest-agent installed on the VM
* On client side, updated browser (Firefox) to latest version (38.0) and 
/ca.crt has been imported into Firefox certs


Regarding logs on the server side, I can see the following:

ovirt-engine


2015-06-16 10:49:29,862 INFO  
[org.ovirt.engine.core.bll.SetVmTicketCommand] (ajp--127.0.0.1-8702-11) 
[39c79276] Running command: SetVmTicketCommand internal: false. Entities 
affected :  ID: c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction 
group CONNECT_TO_VM with role type USER
2015-06-16 10:49:29,917 INFO  
[org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
(ajp--127.0.0.1-8702-11) [39c79276] START, 
SetVmTicketVDSCommand(HostName = ovirtengine.myorg.es, HostId = 
82fb3c43-3a4b-464e-9077-8e86dea2016b, 
vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, ticket=TgrRVYoRhC8T, 
validTime=120,m userName=user, 
userId=5d502bbb-97d6-40b5-abbf-90121cea94d5), log id: 1881c90f
2015-06-16 10:49:29,937 INFO  
[org.ovirt.engine.core.vdsbroker.vdsbroker.SetVmTicketVDSCommand] 
(ajp--127.0.0.1-8702-11) [39c79276] FINISH, SetVmTicketVDSCommand, log 
id: 1881c90f
2015-06-16 10:49:29,957 INFO  
[org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] 
(ajp--127.0.0.1-8702-11) [39c79276] Correlation ID: 39c79276, Call 
Stack: null, Custom Event ID: -1, Message: user user@domain initiated 
console session for VM testVM
2015-06-16 10:49:29,987 WARN  
[org.ovirt.engine.core.dal.job.ExecutionMessageDirector] 
(ajp--127.0.0.1-8702-11) [7a71a9e4] The message key VmLogon is missing 
from bundles/ExecutionMessages
2015-06-16 10:49:30,064 INFO  [org.ovirt.engine.core.bll.VmLogonCommand] 
(ajp--127.0.0.1-8702-11) [7a71a9e4] Running command: VmLogonCommand 
internal: false. Entities affected :  ID: 
c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc Type: VMAction group CONNECT_TO_VM 
with role type USER
2015-06-16 10:49:30,114 INFO  
[org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
(ajp--127.0.0.1-8702-11) [7a71a9e4] START, VmLogonVDSCommand(HostName = 
ovirtengine.myorg.es, HostId = 82fb3c43-3a4b-464e-9077-8e86dea2016b, 
vmId=c2e32d4f-4c54-4e38-bf66-2627dc6dd4bc, domain=domain-authz, 
password=**, userName=user@domain), log id: 68632b24
2015-06-16 10:49:30,120 INFO  
[org.ovirt.engine.core.vdsbroker.vdsbroker.VmLogonVDSCommand] 
(ajp--127.0.0.1-8702-11) [7a71a9e4] FINISH, VmLogonVDSCommand, log id: 
68632b24
2015-06-16 10:49:30,351 INFO  
[org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
(DefaultQuartzScheduler_Worker-2) START, 
GlusterVolumesListVDSCommand(HostName = kvmhost.myorg.es, HostId = 
82fb3c43-3a4b-464e-9077-8e86dea2016b), log id: 2a2a439a
2015-06-16 10:49:30,368 INFO  
[org.ovirt.engine.core.vdsbroker.gluster.GlusterVolumesListVDSCommand] 
(DefaultQuartzScheduler_Worker-2) FINISH, GlusterVolumesListVDSCommand, 
return: {}, log id: 2a2a439a


ovirt-websocket-proxy
=

jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: SSL/TLS (wss://) WebSocket 
connection
jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Version hybi-13, base64: 
'False'
jun 16 09:56:39 ovirtengine.myorg.es ovirt-websocket-proxy.py[30728]: 
10.X.X.X - - [16/Jun/2015 09:56:39] 10.X.X.X: Path: 
'/eyJ2YWxpZFRvIjoiMjAxNTA2MTYwODU4MzgiLCJkYXRhIjoiJTdCJTIyaG9zdCUyMjolMjIxMC4xMDcuMjYuMjAxJTIyLCUyMnBvcnQlMjI6JTIyNTkwMCUyMiwlMjJzc2xfdGFyZ2V0JTIyOnRydWUlN0QiLCJ2YWxpZEZyb20iOiIyMDE1MDYxNjA4NTYzOCIsInNpZ25lZEZpZWxkcyI6InZhbGlkVG8sZGF0YSx2YWxpZEZyb20sc2FsdCIsInNpZ25hdHVyZSI6Imk2a3J2bjFCLzFYbUptSEJjVVZZRWVhSExwenA1LzJBQU1DWmJZcDJsaE9heEYvdkZ3azJIa0hibm5iY21mZFp3STJYbnFzMm9vZnMvNWV3NlNiTGtGeTdaVVdjZG4zdUxTcStZTVg4c3huUzg0Ulg3ZmtLTk05Mk9CeFJENm5VSEVDMXQ1eld0OXo3akZYVktMdXFEYkNiK3RmL3pNZGJuS0ZCcGtXaU5JVVB4b09yd2ZxRUQxMWZTell0aXVFeEFscW5xWlBqSXpjcHNDTHRwQXZaTnNWWWFNQlFWR1U2WnZiZlFWUTBlaFIzMnVyaTlVUmI1NDZCZVBuMkVJdytwU3RIWmZRWit2RDZKUjRWeDJFSFRqVEtXZ2ZMbzRWY0ZjSzNnQURYV1BKbUJjaWx5TExQR3dnTm1ncEk0cjVhR1ZCTmZ1VVUxSENJTlhWUVZPVnJJZz09Iiwic2FsdCI6IndFZGwvcmw3VWZJPSJ9'


Java console


 disconnect spicehtml5-main.html:86:16
 disconnect spicehtml5-main.html:90:16
ERROR: Error: Unexpected protocol mismatch.

-


I can't see any other relevant info, so I wonder if something else might 
be missing on any of the involved machines. Is there something else to 
do?


Thanks.

Nicolás