Xen project Mailing List

Re: [Xen-API] xenserver-core tech preview: Console going crazy

To: "xen-api@xxxxxxxxxxxxx" <xen-api@xxxxxxxxxxxxx>

Date: Tue, 29 Oct 2013 10:11:02 -0500

Delivery-date: Tue, 29 Oct 2013 15:11:18 +0000

List-id: User and development list for XCP and XAPI <xen-api.lists.xen.org>

This has something to do with running 'xe console' without a tty. This breaks: ssh <xenserver> xe console vm=foo Forcing pty allocation works: ssh -t <xenserver> xe console vm=foo John On 10/29/2013 01:05 AM, John Morris wrote: > Next problem: the VM console proxy exits immediately, resulting in a > tight loop that eats up about 1/3 of the CPU. Below is 1.5 cycles > pasted from the debug log. > > John > > > > http://pastebin.ca/2472371 > >> Oct 29 00:51:45 xen27 stunnel: LOG5[13264:140387376142272]: stunnel 4.29 on >> x86_64-redhat-linux-gnu with OpenSSL 1.0.0-fips 29 Mar 2010 >> Oct 29 00:51:45 xen27 stunnel: LOG5[13264:140387376142272]: >> Threading:PTHREAD SSL:ENGINE Sockets:POLL,IPv6 Auth:LIBWRAP >> Oct 29 00:51:45 xen27 stunnel: LOG5[13264:140387376142272]: stunnel accepted >> connection from localhost:#015ÿ#177 >> Oct 29 00:51:45 xen27 stunnel: LOG5[13264:140387376142272]: >> connect_blocking: connected 192.168.7.26:443 >> Oct 29 00:51:45 xen27 stunnel: LOG5[13264:140387376142272]: stunnel >> connected remote server from 192.168.7.26:45115 >> Oct 29 00:51:45 xen27 stunnel: LOG5[2220:140308671461120]: xapi accepted >> connection from ::ffff:192.168.7.26:45115 >> Oct 29 00:51:45 xen27 stunnel: LOG5[2220:140308671461120]: connect_blocking: >> connected 127.0.0.1:80 >> Oct 29 00:51:45 xen27 stunnel: LOG5[2220:140308671461120]: xapi connected >> remote server from 127.0.0.1:46203 >> Oct 29 00:51:45 xen27 xapi: [debug|xen27.zultron.com|2352 INET :::80||http] >> Request { frame = false; method = CONNECT; uri = /console; query = [ >> uuid=6cdba8a9-7be2-2917-ef6d-da09cd31ccb4; >> session_id=OpaqueRef:b251dcb4-8f33-a895-1374-2f9e83466c1d ]; content_length >> = [ 0 ]; transfer encoding = ; version = 1.0; cookie = [ ]; task = ; >> subtask_of = ; content-type = ; host = ; user_agent = } >> Oct 29 00:51:45 xen27 xapi: >> [20131029T05:51:45.560Z|audit|xen27.zultron.com|2352 INET >> :::80|handler:http/connect_console D:19a8eca9ab12|audit] >> ('trackid=abc41a624d6cd5ae06e7b279aec28aaf' 'LOCAL_SUPERUSER' 'root' >> 'ALLOWED' 'OK' 'HTTP' 'http/connect_console' ()) >> Oct 29 00:51:45 xen27 xapi: [debug|xen27.zultron.com|2352 INET >> :::80||db_write] create_row task >> (OpaqueRef:df82fe46-fd33-01ac-a218-5362e2de912c) >> [(_ref,v),(uuid,v),(name__label,v),(name__description,v),(allowed_operations,v),(current_operations,v),(created,v),(finished,v),(status,v),(session,v),(resident_on,v),(progress,v),(externalpid,v),(stunnelpid,v),(forwarded,v),(forwarded_to,v),(type,v),(result,v),(error_info,v),(other_config,v),(subtask_of,v)] >> Oct 29 00:51:45 xen27 xenopsd-xenlight: [xenops_server] VM.stat >> 50c8ab69-7fbc-dacd-78e2-230777596993 >> Oct 29 00:51:45 xen27 xapi: [debug|xen27.zultron.com|2352 INET >> :::80|Connection to VM console R:df82fe46fd33|console] VM >> OpaqueRef:0ae73118-540b-fc53-4405-05c72422eee9 console on: localhost:9501 >> Oct 29 00:51:45 xen27 stunnel: LOG5[2220:140308671461120]: Connection >> closed: 78 bytes sent to SSL, 148 bytes sent to socket >> Oct 29 00:51:45 xen27 xapi: [debug|xen27.zultron.com|2352 INET >> :::80|Connection to VM console R:df82fe46fd33|console] Connected; running >> proxy (between fds: 26 and 27) >> Oct 29 00:51:45 xen27 stunnel: LOG5[13264:140387376142272]: Connection >> closed: 148 bytes sent to SSL, 78 bytes sent to socket >> Oct 29 00:51:45 xen27 xapi: [debug|xen27.zultron.com|2352 INET >> :::80|Connection to VM console R:df82fe46fd33|console] Proxy exited >> Oct 29 00:51:45 xen27 xapi: [debug|xen27.zultron.com|2352 INET >> :::80|Connection to VM console R:df82fe46fd33|redo_log] WriteField(task, >> OpaqueRef:df82fe46-fd33-01ac-a218-5362e2de912c, allowed_operations, (), ()) >> Oct 29 00:51:45 xen27 xapi: [debug|xen27.zultron.com|2352 INET >> :::80|Connection to VM console R:df82fe46fd33|redo_log] WriteField(task, >> OpaqueRef:df82fe46-fd33-01ac-a218-5362e2de912c, finished, >> 19700101T00:00:00Z, 20131029T05:51:45Z) >> Oct 29 00:51:45 xen27 xapi: [debug|xen27.zultron.com|2352 INET >> :::80|Connection to VM console R:df82fe46fd33|redo_log] WriteField(task, >> OpaqueRef:df82fe46-fd33-01ac-a218-5362e2de912c, progress, 0, 1) >> Oct 29 00:51:45 xen27 xapi: [debug|xen27.zultron.com|2352 INET >> :::80|Connection to VM console R:df82fe46fd33|redo_log] WriteField(task, >> OpaqueRef:df82fe46-fd33-01ac-a218-5362e2de912c, status, pending, success) >> Oct 29 00:51:45 xen27 xapi: [debug|xen27.zultron.com|2352 INET >> :::80|Connection to VM console R:df82fe46fd33|db_write] delete_row task >> (OpaqueRef:df82fe46-fd33-01ac-a218-5362e2de912c) > > (Here, stunnel restarts) > >> Oct 29 00:51:45 xen27 stunnel: LOG5[13268:140615311181760]: stunnel 4.29 on >> x86_64-redhat-linux-gnu with OpenSSL 1.0.0-fips 29 Mar 2010 >> Oct 29 00:51:45 xen27 stunnel: LOG5[13268:140615311181760]: >> Threading:PTHREAD SSL:ENGINE Sockets:POLL,IPv6 Auth:LIBWRAP >> Oct 29 00:51:45 xen27 stunnel: LOG5[13268:140615311181760]: stunnel accepted >> connection from localhost:6#177 >> Oct 29 00:51:45 xen27 stunnel: LOG5[13268:140615311181760]: >> connect_blocking: connected 192.168.7.26:443 >> Oct 29 00:51:45 xen27 stunnel: LOG5[13268:140615311181760]: stunnel >> connected remote server from 192.168.7.26:45118 >> Oct 29 00:51:45 xen27 stunnel: LOG5[2220:140308671461120]: xapi accepted >> connection from ::ffff:192.168.7.26:45118 >> Oct 29 00:51:45 xen27 stunnel: LOG5[2220:140308671461120]: connect_blocking: >> connected 127.0.0.1:80 >> Oct 29 00:51:45 xen27 stunnel: LOG5[2220:140308671461120]: xapi connected >> remote server from 127.0.0.1:46206 >> Oct 29 00:51:45 xen27 xapi: [debug|xen27.zultron.com|2353 INET :::80||http] >> Request { frame = false; method = CONNECT; uri = /console; query = [ >> uuid=6cdba8a9-7be2-2917-ef6d-da09cd31ccb4; >> session_id=OpaqueRef:b251dcb4-8f33-a895-1374-2f9e83466c1d ]; content_length >> = [ 0 ]; transfer encoding = ; version = 1.0; cookie = [ ]; task = ; >> subtask_of = ; content-type = ; host = ; user_agent = } >> Oct 29 00:51:45 xen27 xapi: >> [20131029T05:51:45.727Z|audit|xen27.zultron.com|2353 INET >> :::80|handler:http/connect_console D:10a07e7ce7b6|audit] >> ('trackid=abc41a624d6cd5ae06e7b279aec28aaf' 'LOCAL_SUPERUSER' 'root' >> 'ALLOWED' 'OK' 'HTTP' 'http/connect_console' ()) >> Oct 29 00:51:45 xen27 xapi: [debug|xen27.zultron.com|2353 INET >> :::80||db_write] create_row task >> (OpaqueRef:aaa8b406-5942-4eaf-ce6b-c9ae783c1bc5) [(_ref,v),(uuid,v),(nam > > > > _______________________________________________ > Xen-api mailing list > Xen-api@xxxxxxxxxxxxx > http://lists.xen.org/cgi-bin/mailman/listinfo/xen-api > _______________________________________________ Xen-api mailing list Xen-api@xxxxxxxxxxxxx http://lists.xen.org/cgi-bin/mailman/listinfo/xen-api

©2013 Xen Project, A Linux Foundation Collaborative Project. All Rights Reserved.
Linux Foundation is a registered trademark of The Linux Foundation.
Xen Project is a trademark of The Linux Foundation.