Error creating VMs in fresh 0.4.2 install

ghost commented 11 years ago

On a fresh install of OCF 0.4.2, when I try to create a VM, this error shows up in Expedient:

Action create on VM VM1 failed: : 'NoneType' object has no attribute 'evaluate'

This message keeps showing from time to time in the OXA's /opt/ofelia/oxa/log/error.log file:

30/01/2013 12:11:03 PM [Thread-6>MonitoringDispatcher.py:52] ERROR: [Errno 111] Connection refused
Exception in thread Thread-6:
Traceback (most recent call last):
  File "/usr/lib/python2.6/threading.py", line 532, in __bootstrap_inner
    self.run()
  File "/opt/ofelia/oxa/repository/vt_manager/src/python/agent/utils/ServiceThread.py", line 27, in run
    self.__method(self.__param)
  File "/opt/ofelia/oxa/repository/vt_manager/src/python/agent/monitoring/MonitoringDispatcher.py", line 53, in processMonitoring
    raise e
error: [Errno 111] Connection refused

When I try to open the Policy Manager in the VT Manager web interface, /opt/ofelia/vt_manager/src/python/vt_manager/controller/policies/utils/log/pe.log shows:

[30/01/2013 08:48:25 AM] [RuleTableManager.py] [Evaluate] [ERROR]: Denied policy: 'NoneType' object has no attribute 'evaluate'
[30/01/2013 08:48:25 AM] [RuleTableManager.py] [Evaluate] [ERROR]: Denied policy: 'NoneType' object has no attribute 'evaluate'

And in /var/log/apache2/vt_manager/error_log: (there was no pypelib table in any database when I checked...)

[Wed Jan 30 09:51:52 2013] [error] 30/01/2013 09:51:52 AM [Django.py:93] INFO: Django.load
[Wed Jan 30 09:51:52 2013] [error] 30/01/2013 09:51:52 AM [RuleTable.py:246] ERROR: Unable to load RuleTable. Exception: [Django Driver] Some error occurred when trying to fetch table table with name: provisioning. Exception: (1146, "Table 'vtman123.pypelib_RuleTableModel' doesn't exist")
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128] mod_wsgi (pid=654): Exception occurred processing WSGI script '/opt/ofelia/vt_manager/src/wsgi/vt_manager/django.wsgi'.
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128] Traceback (most recent call last):
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/core/handlers/wsgi.py", line 241, in __call__
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     response = self.get_response(request)
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/core/handlers/base.py", line 141, in get_response
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     return self.handle_uncaught_exception(request, resolver, sys.exc_info())
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/core/handlers/base.py", line 100, in get_response
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     response = callback(request, *callback_args, **callback_kwargs)
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/contrib/auth/decorators.py", line 25, in _wrapped_view
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     return view_func(request, *args, **kwargs)
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/opt/ofelia/vt_manager/src/wsgi/vt_manager/../../python/vt_manager/controller/dispatchers/ui/PolicyDispatcher.py", line 29, in rule_table_view
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     'table': ruleTable}
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/views/generic/simple.py", line 18, in direct_to_template
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     return HttpResponse(t.render(c), mimetype=mimetype)
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/template/__init__.py", line 173, in render
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     return self._render(context)
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/template/__init__.py", line 167, in _render
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     return self.nodelist.render(context)
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/template/__init__.py", line 796, in render
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     bits.append(self.render_node(node, context))
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/template/debug.py", line 72, in render_node
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     result = node.render(context)
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/template/loader_tags.py", line 125, in render
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     return compiled_parent._render(context)
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/template/__init__.py", line 167, in _render
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     return self.nodelist.render(context)
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/template/__init__.py", line 796, in render
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     bits.append(self.render_node(node, context))
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/template/debug.py", line 72, in render_node
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     result = node.render(context)
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/template/loader_tags.py", line 62, in render
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     result = block.nodelist.render(context)
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/template/__init__.py", line 796, in render
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     bits.append(self.render_node(node, context))
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/template/debug.py", line 72, in render_node
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     result = node.render(context)
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]   File "/usr/lib/pymodules/python2.6/django/template/defaulttags.py", line 385, in render
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128]     raise e
[Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128] TemplateSyntaxError: Caught NoReverseMatch while rendering: Reverse for 'policy_create' with arguments '('',)' and keyword arguments '{}' not found.

Is something wrong with my installation? Pypelib is installed, but the tables are not being created. What could be happening? Also

CarolinaFernandez commented 11 years ago

Hi Allan,

the error

[Wed Jan 30 09:51:52 2013] [error] 30/01/2013 09:51:52 AM [RuleTable.py:246] ERROR: Unable to load RuleTable. Exception: [Django Driver] Some error occurred when trying to fetch table table with name: provisioning. Exception: (1146, "Table 'vtman123.pypelib_RuleTableModel' doesn't exist") [Wed Jan 30 09:51:52 2013] [error] [client 10.202.35.128] mod_wsgi (pid=654): Exception occurred processing WSGI script '/opt/ofelia/vt_manager/src/wsgi/vt_manager/django.wsgi'.

suggests that there are no tables for PyPElib inside yout VT Manager database (vtman123).

This might be due to the fact that you configured PyPElib prior to the VT manager installation (this is normal) and chose a different database (a.k.a. _applabel inside Django) -- another than vtman123 (this is normal too, since we forgot to warn about this particularity within the PyPElib package, my bad). All of this results in the tables not being created.

Could you try the following?

Go to the following files:

/usr/lib/python2.6/pypelib/persistence/backends/django/RuleModel.py /usr/lib/python2.6/pypelib/persistence/backends/django/RuleTableModel.py

and change manually the value of app_label to the name of your VT Manager database (vtman123 in this case)

Once this is done type:

cd /opt/ofelia/vt_manager/src/python/vt_manager sudo python manage.py syncdb

This should synchronize the PyPElib tables inside the corresponding VT manager database.

Please tell us if that solved the problem ;)

ghost commented 11 years ago

Hi Carolina,

I made these changes, but the error persists. I still can't open the Policy Manager, and the VMs can't be created. I checked, and there are no pypelib tables in database vtman123.

Btw, when running the command you suggested:

$ sudo python manage.py syncdb

/usr/lib/pymodules/python2.6/registration/models.py:4: DeprecationWarning: the sha module is deprecated; use the hashlib module instead
  import sha
No fixtures found.

I also tried removing pypelib (with --purge) and reinstalling it (then it asked for the database and I informed vtman123). Then I tried to reinstall vt_manager (with -f). Neither worked.

CarolinaFernandez commented 11 years ago

Ok, there was an error in my solution. You should use the VT Manager application name (vt_manager), not the name used for its database.

Go to the same files:

/usr/lib/python2.6/pypelib/persistence/backends/django/RuleModel.py /usr/lib/python2.6/pypelib/persistence/backends/django/RuleTableModel.py

and manually change the value of app_label to the name of the VT Manager application:

app_label = 'vt_manager'

Once this is done type the same as before:

cd /opt/ofelia/vt_manager/src/python/vt_manager sudo python manage.py syncdb

Was that OK?

ghost commented 11 years ago

That seems to solve it :) I will only be able to test fully on Tuesday. I will report back. Thanks!

CarolinaFernandez commented 11 years ago

Glad to hear it! Looking forward to your final feedback. :)

ghost commented 11 years ago

Hello again Carolina,

Now Expedient doesn't show any errors, but when I try to create a VM, their states are forever unknown. They are given an IP address, but I'm not able to start or remove them.

I'm still running 0.4.2.

CarolinaFernandez commented 11 years ago

Hi there,

That is a bit strange and might happen because of some attempt to connect to an unreachable agent. Could you search for errors inside the logs for Expedient and VT manager and paste these here? E.g.:

tail -1000f /var/log/apache2/expedient/clearinghouse/error_log tail -1000f /var/log/apache2/vt_manager/error_log

ghost commented 11 years ago

After an attempt to create a VM:

VTManager error_log:

[Tue Feb 05 07:30:34 2013] [error] 05/02/2013 07:30:34 AM [views.py:158] DEBUG: 
[Tue Feb 05 07:30:34 2013] [error] Incoming request
[Tue Feb 05 07:30:34 2013] [error] ----------------
[Tue Feb 05 07:30:34 2013] [error] 05/02/2013 07:30:34 AM [views.py:159] DEBUG: 
[Tue Feb 05 07:30:34 2013] [error] <?xml version='1.0'?>
[Tue Feb 05 07:30:34 2013] [error] <methodCall>
[Tue Feb 05 07:30:34 2013] [error] <methodName>ping</methodName>
[Tue Feb 05 07:30:34 2013] [error] <params>
[Tue Feb 05 07:30:34 2013] [error] <param>
[Tue Feb 05 07:30:34 2013] [error] <value><array><data>
[Tue Feb 05 07:30:34 2013] [error] <value><string>hello</string></value>
[Tue Feb 05 07:30:34 2013] [error] </data></array></value>
[Tue Feb 05 07:30:34 2013] [error] </param>
[Tue Feb 05 07:30:34 2013] [error] </params>
[Tue Feb 05 07:30:34 2013] [error] </methodCall>
[Tue Feb 05 07:30:34 2013] [error] 
[Tue Feb 05 07:30:34 2013] [error] 
[Tue Feb 05 07:30:34 2013] [error] 
[Tue Feb 05 07:30:34 2013] [error] 
[Tue Feb 05 07:30:34 2013] [error] 
[Tue Feb 05 07:30:34 2013] [error] 05/02/2013 07:30:34 AM [views.py:104] DEBUG: Method "ping" is unprotected
[Tue Feb 05 07:30:34 2013] [error] 05/02/2013 07:30:34 AM [views.py:183] DEBUG: Outgoing text/xml request
[Tue Feb 05 07:30:34 2013] [error] ---------------------------
[Tue Feb 05 07:30:34 2013] [error] 05/02/2013 07:30:34 AM [views.py:184] DEBUG: 
[Tue Feb 05 07:30:34 2013] [error] <?xml version='1.0'?>
[Tue Feb 05 07:30:34 2013] [error] <methodResponse>
[Tue Feb 05 07:30:34 2013] [error] <params>
[Tue Feb 05 07:30:34 2013] [error] <param>
[Tue Feb 05 07:30:34 2013] [error] <value><array><data>
[Tue Feb 05 07:30:34 2013] [error] <value><string>hello</string></value>
[Tue Feb 05 07:30:34 2013] [error] </data></array></value>
[Tue Feb 05 07:30:34 2013] [error] </param>
[Tue Feb 05 07:30:34 2013] [error] </params>
[Tue Feb 05 07:30:34 2013] [error] </methodResponse>
[Tue Feb 05 07:30:34 2013] [error] 
[Tue Feb 05 07:30:34 2013] [error] 
[Tue Feb 05 07:30:34 2013] [error] 
[Tue Feb 05 07:30:34 2013] [error] 
[Tue Feb 05 07:30:34 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [views.py:158] DEBUG: 
[Tue Feb 05 07:30:37 2013] [error] Incoming request
[Tue Feb 05 07:30:37 2013] [error] ----------------
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [views.py:159] DEBUG: 
[Tue Feb 05 07:30:37 2013] [error] <?xml version='1.0'?>
[Tue Feb 05 07:30:37 2013] [error] <methodCall>
[Tue Feb 05 07:30:37 2013] [error] <methodName>send</methodName>
[Tue Feb 05 07:30:37 2013] [error] <params>
[Tue Feb 05 07:30:37 2013] [error] <param>
[Tue Feb 05 07:30:37 2013] [error] <value><string>https://fibre:pwd@0.0.0.0/vt_plugin/xmlrpc/vt_am/</string></value>
[Tue Feb 05 07:30:37 2013] [error] </param>
[Tue Feb 05 07:30:37 2013] [error] <param>
[Tue Feb 05 07:30:37 2013] [error] <value><string>&lt;?xml version="1.0" encoding="UTF-8"?&gt;
[Tue Feb 05 07:30:37 2013] [error] &lt;rspec&gt;
[Tue Feb 05 07:30:37 2013] [error]     &lt;query&gt;
[Tue Feb 05 07:30:37 2013] [error]         &lt;provisioning&gt;
[Tue Feb 05 07:30:37 2013] [error]             &lt;action type="create" id="a4453b55-3717-4e29-9aed-85e488fbd653"&gt;
[Tue Feb 05 07:30:37 2013] [error]                 &lt;server&gt;
[Tue Feb 05 07:30:37 2013] [error]                     &lt;uuid&gt;8018cc81-ff50-43ad-b8a4-ce3d558c6021&lt;/uuid&gt;
[Tue Feb 05 07:30:37 2013] [error]                     &lt;virtualization-type&gt;xen&lt;/virtualization-type&gt;
[Tue Feb 05 07:30:37 2013] [error]                     &lt;virtual-machines&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;name&gt;VM3&lt;/name&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;uuid&gt;84afab63-97e5-4c64-8c8a-96136ef0bf0d&lt;/uuid&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;status&gt;on queue&lt;/status&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;project-id&gt;2659cd6f-861c-44e4-a982-a461def816b8&lt;/project-id&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;project-name&gt;Project1&lt;/project-name&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;slice-id&gt;87462921-fcf3-42a2-b469-2e31b868c8c4&lt;/slice-id&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;slice-name&gt;SliceA&lt;/slice-name&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;operating-system-type&gt;GNU/Linux&lt;/operating-system-type&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;operating-system-version&gt;6.0&lt;/operating-system-version&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;operating-system-distribution&gt;Debian&lt;/operating-system-distribution&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;server-id&gt;8018cc81-ff50-43ad-b8a4-ce3d558c6021&lt;/server-id&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;virtualization-type&gt;xen&lt;/virtualization-type&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;xen-configuration&gt;
[Tue Feb 05 07:30:37 2013] [error]                             &lt;hd-setup-type&gt;file-image&lt;/hd-setup-type&gt;
[Tue Feb 05 07:30:37 2013] [error]                             &lt;hd-size-mb&gt;8200&lt;/hd-size-mb&gt;
[Tue Feb 05 07:30:37 2013] [error]                             &lt;hd-origin-path&gt;default/default.tar.gz&lt;/hd-origin-path&gt;
[Tue Feb 05 07:30:37 2013] [error]                             &lt;virtualization-setup-type&gt;paravirtualization&lt;/virtualization-setup-type&gt;
[Tue Feb 05 07:30:37 2013] [error]                             &lt;memory-mb&gt;256&lt;/memory-mb&gt;
[Tue Feb 05 07:30:37 2013] [error]                             &lt;interfaces&gt;
[Tue Feb 05 07:30:37 2013] [error]                                 &lt;interface ismgmt="true"&gt;
[Tue Feb 05 07:30:37 2013] [error]                                     &lt;name&gt;NONE&lt;/name&gt;
[Tue Feb 05 07:30:37 2013] [error]                                     &lt;mac&gt;NONE&lt;/mac&gt;
[Tue Feb 05 07:30:37 2013] [error]                                     &lt;ip&gt;NONE&lt;/ip&gt;
[Tue Feb 05 07:30:37 2013] [error]                                     &lt;mask&gt;NONE&lt;/mask&gt;
[Tue Feb 05 07:30:37 2013] [error]                                     &lt;gw&gt;NONE&lt;/gw&gt;
[Tue Feb 05 07:30:37 2013] [error]                                     &lt;dns1&gt;NONE&lt;/dns1&gt;
[Tue Feb 05 07:30:37 2013] [error]                                     &lt;dns2&gt;NONE&lt;/dns2&gt;
[Tue Feb 05 07:30:37 2013] [error]                                     &lt;switch-id&gt;NONE&lt;/switch-id&gt;
[Tue Feb 05 07:30:37 2013] [error]                                 &lt;/interface&gt;
[Tue Feb 05 07:30:37 2013] [error]                             &lt;/interfaces&gt;
[Tue Feb 05 07:30:37 2013] [error]                         &lt;/xen-configuration&gt;
[Tue Feb 05 07:30:37 2013] [error]                     &lt;/virtual-machines&gt;
[Tue Feb 05 07:30:37 2013] [error]                 &lt;/server&gt;
[Tue Feb 05 07:30:37 2013] [error]             &lt;/action&gt;
[Tue Feb 05 07:30:37 2013] [error]         &lt;/provisioning&gt;
[Tue Feb 05 07:30:37 2013] [error]     &lt;/query&gt;
[Tue Feb 05 07:30:37 2013] [error] &lt;/rspec&gt;
[Tue Feb 05 07:30:37 2013] [error] </string></value>
[Tue Feb 05 07:30:37 2013] [error] </param>
[Tue Feb 05 07:30:37 2013] [error] </params>
[Tue Feb 05 07:30:37 2013] [error] </methodCall>
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [views.py:104] DEBUG: Method "send" is unprotected
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [northCommInterface.py:20] DEBUG: XML RECEIVED: 
[Tue Feb 05 07:30:37 2013] [error] <?xml version="1.0" encoding="UTF-8"?>
[Tue Feb 05 07:30:37 2013] [error] <rspec>
[Tue Feb 05 07:30:37 2013] [error]     <query>
[Tue Feb 05 07:30:37 2013] [error]         <provisioning>
[Tue Feb 05 07:30:37 2013] [error]             <action type="create" id="a4453b55-3717-4e29-9aed-85e488fbd653">
[Tue Feb 05 07:30:37 2013] [error]                 <server>
[Tue Feb 05 07:30:37 2013] [error]                     <uuid>8018cc81-ff50-43ad-b8a4-ce3d558c6021</uuid>
[Tue Feb 05 07:30:37 2013] [error]                     <virtualization-type>xen</virtualization-type>
[Tue Feb 05 07:30:37 2013] [error]                     <virtual-machines>
[Tue Feb 05 07:30:37 2013] [error]                         <name>VM3</name>
[Tue Feb 05 07:30:37 2013] [error]                         <uuid>84afab63-97e5-4c64-8c8a-96136ef0bf0d</uuid>
[Tue Feb 05 07:30:37 2013] [error]                         <status>on queue</status>
[Tue Feb 05 07:30:37 2013] [error]                         <project-id>2659cd6f-861c-44e4-a982-a461def816b8</project-id>
[Tue Feb 05 07:30:37 2013] [error]                         <project-name>Project1</project-name>
[Tue Feb 05 07:30:37 2013] [error]                         <slice-id>87462921-fcf3-42a2-b469-2e31b868c8c4</slice-id>
[Tue Feb 05 07:30:37 2013] [error]                         <slice-name>SliceA</slice-name>
[Tue Feb 05 07:30:37 2013] [error]                         <operating-system-type>GNU/Linux</operating-system-type>
[Tue Feb 05 07:30:37 2013] [error]                         <operating-system-version>6.0</operating-system-version>
[Tue Feb 05 07:30:37 2013] [error]                         <operating-system-distribution>Debian</operating-system-distribution>
[Tue Feb 05 07:30:37 2013] [error]                         <server-id>8018cc81-ff50-43ad-b8a4-ce3d558c6021</server-id>
[Tue Feb 05 07:30:37 2013] [error]                         <virtualization-type>xen</virtualization-type>
[Tue Feb 05 07:30:37 2013] [error]                         <xen-configuration>
[Tue Feb 05 07:30:37 2013] [error]                             <hd-setup-type>file-image</hd-setup-type>
[Tue Feb 05 07:30:37 2013] [error]                             <hd-size-mb>8200</hd-size-mb>
[Tue Feb 05 07:30:37 2013] [error]                             <hd-origin-path>default/default.tar.gz</hd-origin-path>
[Tue Feb 05 07:30:37 2013] [error]                             <virtualization-setup-type>paravirtualization</virtualization-setup-type>
[Tue Feb 05 07:30:37 2013] [error]                             <memory-mb>256</memory-mb>
[Tue Feb 05 07:30:37 2013] [error]                             <interfaces>
[Tue Feb 05 07:30:37 2013] [error]                                 <interface ismgmt="true">
[Tue Feb 05 07:30:37 2013] [error]                                     <name>NONE</name>
[Tue Feb 05 07:30:37 2013] [error]                                     <mac>NONE</mac>
[Tue Feb 05 07:30:37 2013] [error]                                     <ip>NONE</ip>
[Tue Feb 05 07:30:37 2013] [error]                                     <mask>NONE</mask>
[Tue Feb 05 07:30:37 2013] [error]                                     <gw>NONE</gw>
[Tue Feb 05 07:30:37 2013] [error]                                     <dns1>NONE</dns1>
[Tue Feb 05 07:30:37 2013] [error]                                     <dns2>NONE</dns2>
[Tue Feb 05 07:30:37 2013] [error]                                     <switch-id>NONE</switch-id>
[Tue Feb 05 07:30:37 2013] [error]                                 </interface>
[Tue Feb 05 07:30:37 2013] [error]                             </interfaces>
[Tue Feb 05 07:30:37 2013] [error]                         </xen-configuration>
[Tue Feb 05 07:30:37 2013] [error]                     </virtual-machines>
[Tue Feb 05 07:30:37 2013] [error]                 </server>
[Tue Feb 05 07:30:37 2013] [error]             </action>
[Tue Feb 05 07:30:37 2013] [error]         </provisioning>
[Tue Feb 05 07:30:37 2013] [error]     </query>
[Tue Feb 05 07:30:37 2013] [error] </rspec>
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] Parsing XML...
[Tue Feb 05 07:30:37 2013] [error] Parsing of XML concluded without significant errors.
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [views.py:183] DEBUG: Outgoing text/xml request
[Tue Feb 05 07:30:37 2013] [error] ---------------------------
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [views.py:184] DEBUG: 
[Tue Feb 05 07:30:37 2013] [error] <?xml version='1.0'?>
[Tue Feb 05 07:30:37 2013] [error] <methodResponse>
[Tue Feb 05 07:30:37 2013] [error] <params>
[Tue Feb 05 07:30:37 2013] [error] <param>
[Tue Feb 05 07:30:37 2013] [error] <value><nil/></value></param>
[Tue Feb 05 07:30:37 2013] [error] </params>
[Tue Feb 05 07:30:37 2013] [error] </methodResponse>
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [ProvisioningDispatcher.py:18] DEBUG: PROVISIONING STARTED...
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [ProvisioningDispatcher.py:21] DEBUG: ACTION type: create with id: a4453b55-3717-4e29-9aed-85e488fbd653
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [Django.py:93] INFO: Django.load
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [views.py:158] DEBUG: 
[Tue Feb 05 07:30:37 2013] [error] Incoming request
[Tue Feb 05 07:30:37 2013] [error] ----------------
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [views.py:159] DEBUG: 
[Tue Feb 05 07:30:37 2013] [error] <?xml version='1.0'?>
[Tue Feb 05 07:30:37 2013] [error] <methodCall>
[Tue Feb 05 07:30:37 2013] [error] <methodName>listResources</methodName>
[Tue Feb 05 07:30:37 2013] [error] <params>
[Tue Feb 05 07:30:37 2013] [error] <param>
[Tue Feb 05 07:30:37 2013] [error] <value><string>2698528899738647685</string></value>
[Tue Feb 05 07:30:37 2013] [error] </param>
[Tue Feb 05 07:30:37 2013] [error] <param>
[Tue Feb 05 07:30:37 2013] [error] <value><string>2659cd6f-861c-44e4-a982-a461def816b8</string></value>
[Tue Feb 05 07:30:37 2013] [error] </param>
[Tue Feb 05 07:30:37 2013] [error] <param>
[Tue Feb 05 07:30:37 2013] [error] <value><string>87462921-fcf3-42a2-b469-2e31b868c8c4</string></value>
[Tue Feb 05 07:30:37 2013] [error] </param>
[Tue Feb 05 07:30:37 2013] [error] </params>
[Tue Feb 05 07:30:37 2013] [error] </methodCall>
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [views.py:104] DEBUG: Method "listResources" is unprotected
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [InformationDispatcher.py:14] DEBUG: Enter listResources
[Tue Feb 05 07:30:37 2013] [error] Parsing XML...
[Tue Feb 05 07:30:37 2013] [error] Parsing of XML concluded without significant errors.
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [Django.py:142] DEBUG: Loading Rule set...
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [RuleTableManager.py:169] DEBUG: All policies were accepted
[Tue Feb 05 07:30:37 2013] [error] Crafting Model...
[Tue Feb 05 07:30:37 2013] [error] Crafting of the XML Class concluded without significant errors.
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [views.py:183] DEBUG: Outgoing text/xml request
[Tue Feb 05 07:30:37 2013] [error] ---------------------------
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [views.py:184] DEBUG: 
[Tue Feb 05 07:30:37 2013] [error] <?xml version='1.0'?>
[Tue Feb 05 07:30:37 2013] [error] <methodResponse>
[Tue Feb 05 07:30:37 2013] [error] <params>
[Tue Feb 05 07:30:37 2013] [error] <param>
[Tue Feb 05 07:30:37 2013] [error] <value><array><data>
[Tue Feb 05 07:30:37 2013] [error] <value><string>2698528899738647685</string></value>
[Tue Feb 05 07:30:37 2013] [error] <value><string></string></value>
[Tue Feb 05 07:30:37 2013] [error] </data></array></value>
[Tue Feb 05 07:30:37 2013] [error] </param>
[Tue Feb 05 07:30:37 2013] [error] </params>
[Tue Feb 05 07:30:37 2013] [error] </methodResponse>
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] 
[Tue Feb 05 07:30:37 2013] [error] Parsing XML...
[Tue Feb 05 07:30:37 2013] [error] Parsing of XML concluded without significant errors.
[Tue Feb 05 07:30:37 2013] [error] Crafting Model...
[Tue Feb 05 07:30:37 2013] [error] Crafting of the XML Class concluded without significant errors.
[Tue Feb 05 07:30:37 2013] [error] 05/02/2013 07:30:37 AM [ProvisioningDispatcher.py:71] DEBUG: PROVISIONING FINISHED...

ClearingHouse error_log:

[Tue Feb 05 05:29:55 2013] [error] 2698528899738647685
[Tue Feb 05 05:29:55 2013] [error] Same HASH, no changes in resources
[Tue Feb 05 05:30:36 2013] [error] Parsing XML...
[Tue Feb 05 05:30:36 2013] [error] Parsing of XML concluded without significant errors.
[Tue Feb 05 05:30:36 2013] [error] Parsing XML...
[Tue Feb 05 05:30:36 2013] [error] Parsing of XML concluded without significant errors.
[Tue Feb 05 05:30:36 2013] [error] Crafting Model...
[Tue Feb 05 05:30:36 2013] [error] Crafting of the XML Class concluded without significant errors.
[Tue Feb 05 05:30:37 2013] [error] 2698528899738647685
[Tue Feb 05 05:30:37 2013] [error] Same HASH, no changes in resources

And every time I try to create a VM, this shows up in /opt/ofelia/oxa/log/error.log (in the agent):

05/02/2013 11:30:37 AM [Thread-13>ProvisioningDispatcher.py:69] ERROR: [Errno 111] Connection refused
Exception in thread Thread-13:
Traceback (most recent call last):
  File "/usr/lib/python2.6/threading.py", line 532, in __bootstrap_inner
    self.run()
  File "/opt/ofelia/oxa/repository/vt_manager/src/python/agent/utils/ServiceThread.py", line 27, in run
    self.__method(self.__param)
  File "/opt/ofelia/oxa/repository/vt_manager/src/python/agent/provisioning/ProvisioningDispatcher.py", line 70, in processProvisioning
    raise e
error: [Errno 111] Connection refused

ghost commented 11 years ago

I solved it. Like you said, the server running the agent was unable to reach the vt_manager. It was my mistake.

In the vt_manager's settings file, I had:

#
# IP and port you would like to use to access Expedient GUI.
#
VTAM_IP = "0.0.0.0"
VTAM_PORT = "8445"

And it should be:

#
# IP and port you would like to use to access Expedient GUI.
#
VTAM_IP = "[Actual address]"
VTAM_PORT = "8445"

I thought it was just some convenience setting, but it isn't :D

Should I change this somewhere else? What's this value's real meaning?

CarolinaFernandez commented 11 years ago

Hey,

I get why you thought it was an accessory setting. Next release will have a description according to its importance.

Well then, this values conform the address that shall receive data from the agent (e.g. https://fibre:pwd@0.0.0.0/vt_plugin/xmlrpc/vt_am is the address that the agent was using to transmit virtualization information to the VT manager). This is quite an important setting because without it the VT manager won't receive any response of its petitions, even if the resources were effectively allocated...

That value is set there once, no need to change that in any other place. But make sure to fill every setting in the other modules as well, because all of them are important to us... :)

For example, for Expedient and Opt-in Manager there is the setting SITE_DOMAIN that should have a (domain) valid value; because the e-mails sent to both users and Island Manager will use this to generate a link to the Control Framework.

ghost commented 11 years ago

Yep, I force installed 0.4.3 and updated these values. Can the SITE_DOMAIN be an IP Address?

Is there a way to remove the invalid VMs I created? They're stuck there...

I think it's a closed issue now :)

Thanks for the help!

CarolinaFernandez commented 11 years ago

To your questions:

1: Yes, it can be an IP address. In the sample we set a domain because public url's are that way -- and because these are more human-friendly. Anyway, you can use it for IPs without any problem.
2: You may try some development scripts located at /opt/ofelia/vt_manager/src/python/vt_manager/tests/ (deleteVM.py and/or deleteAllVMs.py). For the first script you need to pass a numeric id which you may find looking to the code in the slice detail page (the list of VMs in the bottom of the page). The code you are looking for is something like:

And has the VM ID inside. So far I have used this for that purpose, but won't assure it will work 100%. Give it a try anyway! ;)

fp7-ofelia / ocf

Error creating VMs in fresh 0.4.2 install #114