← Back to team overview

yahoo-eng-team team mailing list archive

[Bug 1292139] [NEW] nova boot from volume fails nova/compute/manager.py KeyError: 'name'

 

Public bug reported:

Running devstack master icehouse
nova version 2.17.02


cinder list
+--------------------------------------+-----------+-----------------+------+-------------+----------+-------------+
|                  ID                  |   Status  |   Display Name  | Size | Volume Type | Bootable | Attached to |
+--------------------------------------+-----------+-----------------+------+-------------+----------+-------------+
| a2d1e94f-1eed-4a93-9bbd-4994449482c1 | available | 11-LH-vol-image |  40  |   lefthand  |   true   |             |
+--------------------------------------+-----------+-----------------+------+-------------+----------+-------------+


nova boot --flavor 1 --boot-volume a2d1e94f-1eed-4a93-9bbd-4994449482c 77-inst-vol-Lefthand-flav1

TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 974, in _run_instance
TRACE oslo.messaging.rpc.dispatcher     extra_usage_info = {"image_name": image_meta['name']}
TRACE oslo.messaging.rpc.dispatcher KeyError: 'name'


2014-03-13 08:22:50.849 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is ade60d8576b34d99876d649eac10598b from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:22:50.849 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is c1fc84e4e9024a86badc0fe46b6e8028. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:22:50.867 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is ef94d991c0f443f6a99c8efd02d9f065 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:22:50.867 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 05de1846140c46afaec5ecf7957be384. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:22:50.905 AUDIT nova.compute.resource_tracker [-] Free ram (MB): 96137
2014-03-13 08:22:50.905 AUDIT nova.compute.resource_tracker [-] Free disk (GB): 180
2014-03-13 08:22:50.906 AUDIT nova.compute.resource_tracker [-] Free VCPUS: 32
2014-03-13 08:22:50.906 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is bfda17d193bd4591b340f474f584f80e from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:22:50.907 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 5c6b1c34e2774c05b1b5288632d995bf. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:22:50.935 INFO nova.compute.resource_tracker [-] Compute_service record updated for cld2b9:cld2b9
2014-03-13 08:22:50.935 DEBUG nova.openstack.common.lockutils [-] Semaphore / lock released "update_available_resource" from (pid=21675) inner /opt/stack/nova/nova/openstack/common/lockutils.py:252
2014-03-13 08:22:50.936 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is cc8ee588d31d49348917383703201705 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:22:50.936 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is b07b07e333fe484aa8574ee584fc68c8. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:22:50.968 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._poll_rebooting_instances from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
2014-03-13 08:22:50.969 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._cleanup_running_deleted_instances from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
2014-03-13 08:22:50.980 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is d15f259dbba847dd932f355b5a0c0c22 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:22:50.980 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 81adf43fdc5d41359fbb560d4ca3c04e. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:22:51.007 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._reclaim_queued_deletes from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
2014-03-13 08:22:51.007 DEBUG nova.compute.manager [-] CONF.reclaim_instance_interval <= 0, skipping... from (pid=21675) _reclaim_queued_deletes /opt/stack/nova/nova/compute/manager.py:5067
2014-03-13 08:22:51.007 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._poll_unconfirmed_resizes from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
2014-03-13 08:22:51.008 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._poll_rescued_instances from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
2014-03-13 08:22:51.008 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._poll_shelved_instances from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
2014-03-13 08:22:51.009 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._check_instance_build_time from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
2014-03-13 08:22:51.009 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._heal_instance_info_cache from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
2014-03-13 08:22:51.009 DEBUG nova.openstack.common.loopingcall [-] Dynamic looping call sleeping for 60.00 seconds from (pid=21675) _inner /opt/stack/nova/nova/openstack/common/loopingcall.py:132
2014-03-13 08:22:57.460 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is 1d674d267f1446318b11fce3d1d7acd8 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:22:57.460 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is ecf715aa42264799a952270e5ab472a9. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:23:07.462 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is 709253c5a695494097d4e9ee3f09c942 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:23:07.463 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 2cc24381bd224cea81b8cf3698dd2c56. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:23:17.466 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is aac959cfd171485eba63532cfa5920cc from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:23:17.466 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 95fab99733dd4b0bb09222e19f1f8ec7. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:23:27.466 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is ade8e7bb73fc49c0996c5a515cdd6aed from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:23:27.466 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is c326b1efdd5f44d98a91327a786cb446. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:23:29.511 DEBUG oslo.messaging._drivers.amqpdriver [-] received {u'_context_roles': [u'admin'], u'_context_request_id': u'req-b142be5e-9765-4743-bd7d-fda16220cb33', u'_context_quota_class': None, u'_context_instance_lock_checked': False, u'_context_project_name': u'demo', u'_context_service_catalog': [{u'endpoints': [{u'adminURL': u'http://10.50.128.11:8776/v1/978c15471af74381b4a56984df6600b3', u'region': u'RegionOne', u'internalURL': u'http://10.50.128.11:8776/v1/978c15471af74381b4a56984df6600b3', u'serviceName': u'cinder', u'id': u'0699c811d8534cbdb944271c2ed62d93', u'publicURL': u'http://10.50.128.11:8776/v1/978c15471af74381b4a56984df6600b3'}], u'endpoints_links': [], u'type': u'volume', u'name': u'cinder'}], u'args': {u'node': u'cld2b9', u'legacy_bdm_in_spec': False, u'request_spec': {u'num_instances': 1, u'block_device_mapping': [{u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'boot_index': 0, u'no_device': None, u'connection_info': None, u'image_id': None, u'volume_id': u'a2d1e94f-1eed-4a93-9bbd-4994449482c1', u'device_name': u'vda', u'volume_size': None, u'source_type': u'volume', u'snapshot_id': None, u'destination_type': u'volume', u'delete_on_termination': False}], u'image': {u'properties': {u'container_format': u'bare', u'min_ram': u'0', u'disk_format': u'qcow2', u'image_name': u'Ubuntu12_04', u'image_id': u'a78b1876-b590-46f6-b952-a582cc4a9fe5', u'checksum': u'8eb1e06aca4d7dcd3b945f9f818b2545', u'min_disk': u'0', u'size': u'255328768'}}, u'instance_type': {u'root_gb': 0, u'name': u'm1.nano', u'ephemeral_gb': 0, u'memory_mb': 64, u'vcpus': 1, u'extra_specs': {}, u'swap': 0, u'rxtx_factor': 1.0, u'flavorid': u'42', u'vcpu_weight': None, u'id': 6}, u'instance_properties': {u'vm_state': u'building', u'availability_zone': u'nova', u'terminated_at': None, u'ephemeral_gb': 0, u'instance_type_id': 6, u'user_data': None, u'cleaned': False, u'vm_mode': None, u'deleted_at': None, u'reservation_id': u'r-y0mn6obr', u'id': 2, u'security_groups': [{u'project_id': u'978c15471af74381b4a56984df6600b3', u'user_id': u'78a306a768c345edadeaf2305eebf370', u'description': u'default', u'deleted': False, u'created_at': u'2014-03-13T15:15:52.000000', u'updated_at': None, u'deleted_at': None, u'id': 1, u'name': u'default'}], u'disable_terminate': False, u'display_name': u'inst2-LH-vol', u'uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'default_swap_device': None, u'info_cache': {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': False, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'network_info': [], u'deleted_at': None}, u'hostname': u'inst2-lh-vol', u'launched_on': None, u'display_description': u'inst2-LH-vol', u'key_data': u'ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQDR+WJJaonpQSdI5RkuY43pSlYigENx9/mRjTfpxxJ2JN8oP44m9lnpKGLG5KhaOL5wcgvdO7AhvudQwgYkK0SA7wNtWaJFZ6U71XF6CbPXfw00tEs8dV49+UWsxHk0K+nenTjCQsdwNCJtP4yAoEbHNUkqF0fFHrnfnPhdPLASKwPnaFIXsRA01ZrAg9KD4Xep/bCIDb6jQ4pzDEDZYv5+aIeWd5AqEpR0GiyWxJJCCPWgEvmU9uVfOsZUqv+USNnDxavVc+X48H8G+gyhExB5JwQ7A/0TljriXRLguk43PnRfPDghE2by3f66mI/nMuGmzQFN94oApsrG13NV0UxL stack@devstack01\n', u'kernel_id': u'', u'power_state': 0, u'default_ephemeral_device': None, u'progress': 0, u'project_id': u'978c15471af74381b4a56984df6600b3', u'launched_at': None, u'config_drive': u'', u'node': None, u'ramdisk_id': u'', u'access_ip_v6': None, u'access_ip_v4': None, u'deleted': False, u'key_name': u'devstack', u'updated_at': None, u'host': None, u'ephemeral_key_uuid': None, u'architecture': None, u'user_id': u'78a306a768c345edadeaf2305eebf370', u'system_metadata': {u'instance_type_memory_mb': u'64', u'instance_type_swap': u'0', u'image_base_image_ref': u'', u'instance_type_vcpu_weight': None, u'instance_type_root_gb': u'0', u'instance_type_id': u'6', u'instance_type_name': u'm1.nano', u'image_image_name': u'Ubuntu12_04', u'instance_type_ephemeral_gb': u'0', u'image_disk_format': u'qcow2', u'instance_type_rxtx_factor': u'1.0', u'image_container_format': u'bare', u'image_image_id': u'a78b1876-b590-46f6-b952-a582cc4a9fe5', u'instance_type_flavorid': u'42', u'image_size': u'255328768', u'instance_type_vcpus': u'1', u'image_min_ram': u'0', u'image_min_disk': u'0', u'image_checksum': u'8eb1e06aca4d7dcd3b945f9f818b2545'}, u'task_state': u'scheduling', u'shutdown_terminate': False, u'cell_name': None, u'root_gb': 0, u'locked': False, u'name': u'instance-00000002', u'created_at': u'2014-03-13T15:23:29.000000', u'locked_by': None, u'launch_index': 0, u'metadata': {}, u'memory_mb': 64, u'vcpus': 1, u'image_ref': u'', u'root_device_name': None, u'auto_disk_config': True, u'os_type': None, u'scheduled_at': None}, u'security_group': [u'default'], u'instance_uuids': [u'a913af99-46e1-4425-9fc1-feba5ebcc84d']}, u'requested_networks': None, u'filter_properties': {u'config_options': {}, u'limits': {u'memory_mb': 144973.5}, u'request_spec': {u'num_instances': 1, u'block_device_mapping': [{u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'boot_index': 0, u'no_device': None, u'connection_info': None, u'image_id': None, u'volume_id': u'a2d1e94f-1eed-4a93-9bbd-4994449482c1', u'device_name': u'vda', u'volume_size': None, u'source_type': u'volume', u'snapshot_id': None, u'destination_type': u'volume', u'delete_on_termination': False}], u'image': {u'properties': {u'container_format': u'bare', u'min_ram': u'0', u'disk_format': u'qcow2', u'image_name': u'Ubuntu12_04', u'image_id': u'a78b1876-b590-46f6-b952-a582cc4a9fe5', u'checksum': u'8eb1e06aca4d7dcd3b945f9f818b2545', u'min_disk': u'0', u'size': u'255328768'}}, u'instance_type': {u'root_gb': 0, u'name': u'm1.nano', u'ephemeral_gb': 0, u'memory_mb': 64, u'vcpus': 1, u'extra_specs': {}, u'swap': 0, u'rxtx_factor': 1.0, u'flavorid': u'42', u'vcpu_weight': None, u'id': 6}, u'instance_properties': {u'vm_state': u'building', u'availability_zone': u'nova', u'terminated_at': None, u'ephemeral_gb': 0, u'instance_type_id': 6, u'user_data': None, u'cleaned': False, u'vm_mode': None, u'deleted_at': None, u'reservation_id': u'r-y0mn6obr', u'id': 2, u'security_groups': [{u'project_id': u'978c15471af74381b4a56984df6600b3', u'user_id': u'78a306a768c345edadeaf2305eebf370', u'description': u'default', u'deleted': False, u'created_at': u'2014-03-13T15:15:52.000000', u'updated_at': None, u'deleted_at': None, u'id': 1, u'name': u'default'}], u'disable_terminate': False, u'display_name': u'inst2-LH-vol', u'uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'default_swap_device': None, u'info_cache': {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': False, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'network_info': [], u'deleted_at': None}, u'hostname': u'inst2-lh-vol', u'launched_on': None, u'display_description': u'inst2-LH-vol', u'key_data': u'ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQDR+WJJaonpQSdI5RkuY43pSlYigENx9/mRjTfpxxJ2JN8oP44m9lnpKGLG5KhaOL5wcgvdO7AhvudQwgYkK0SA7wNtWaJFZ6U71XF6CbPXfw00tEs8dV49+UWsxHk0K+nenTjCQsdwNCJtP4yAoEbHNUkqF0fFHrnfnPhdPLASKwPnaFIXsRA01ZrAg9KD4Xep/bCIDb6jQ4pzDEDZYv5+aIeWd5AqEpR0GiyWxJJCCPWgEvmU9uVfOsZUqv+USNnDxavVc+X48H8G+gyhExB5JwQ7A/0TljriXRLguk43PnRfPDghE2by3f66mI/nMuGmzQFN94oApsrG13NV0UxL stack@devstack01\n', u'kernel_id': u'', u'power_state': 0, u'default_ephemeral_device': None, u'progress': 0, u'project_id': u'978c15471af74381b4a56984df6600b3', u'launched_at': None, u'config_drive': u'', u'node': None, u'ramdisk_id': u'', u'access_ip_v6': None, u'access_ip_v4': None, u'deleted': False, u'key_name': u'devstack', u'updated_at': None, u'host': None, u'ephemeral_key_uuid': None, u'architecture': None, u'user_id': u'78a306a768c345edadeaf2305eebf370', u'system_metadata': {u'instance_type_memory_mb': u'64', u'instance_type_swap': u'0', u'image_base_image_ref': u'', u'instance_type_vcpu_weight': None, u'instance_type_root_gb': u'0', u'instance_type_id': u'6', u'instance_type_name': u'm1.nano', u'image_image_name': u'Ubuntu12_04', u'instance_type_ephemeral_gb': u'0', u'image_disk_format': u'qcow2', u'instance_type_rxtx_factor': u'1.0', u'image_container_format': u'bare', u'image_image_id': u'a78b1876-b590-46f6-b952-a582cc4a9fe5', u'instance_type_flavorid': u'42', u'image_size': u'255328768', u'instance_type_vcpus': u'1', u'image_min_ram': u'0', u'image_min_disk': u'0', u'image_checksum': u'8eb1e06aca4d7dcd3b945f9f818b2545'}, u'task_state': u'scheduling', u'shutdown_terminate': False, u'cell_name': None, u'root_gb': 0, u'locked': False, u'name': u'instance-00000002', u'created_at': u'2014-03-13T15:23:29.000000', u'locked_by': None, u'launch_index': 0, u'metadata': {}, u'memory_mb': 64, u'vcpus': 1, u'image_ref': u'', u'root_device_name': None, u'auto_disk_config': True, u'os_type': None, u'scheduled_at': None}, u'security_group': [u'default'], u'instance_uuids': [u'a913af99-46e1-4425-9fc1-feba5ebcc84d']}, u'instance_type': {u'root_gb': 0, u'name': u'm1.nano', u'ephemeral_gb': 0, u'memory_mb': 64, u'vcpus': 1, u'extra_specs': {}, u'swap': 0, u'rxtx_factor': 1.0, u'flavorid': u'42', u'vcpu_weight': None, u'id': 6}, u'retry': {u'num_attempts': 1, u'hosts': [[u'cld2b9', u'cld2b9']]}, u'os_type': None, u'project_id': u'978c15471af74381b4a56984df6600b3', u'scheduler_hints': {}}, u'instance': {u'vm_state': u'building', u'internal_id': None, u'availability_zone': u'nova', u'terminated_at': None, u'ephemeral_gb': 0, u'instance_type_id': 6, u'user_data': None, u'cleaned': 0, u'vm_mode': None, u'deleted_at': None, u'reservation_id': u'r-y0mn6obr', u'id': 2, u'security_groups': [{u'deleted_at': None, u'user_id': u'78a306a768c345edadeaf2305eebf370', u'name': u'default', u'deleted': 0, u'created_at': u'2014-03-13T15:15:52.000000', u'updated_at': None, u'rules': [], u'project_id': u'978c15471af74381b4a56984df6600b3', u'id': 1, u'description': u'default'}], u'disable_terminate': False, u'user_id': u'78a306a768c345edadeaf2305eebf370', u'uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'default_swap_device': None, u'info_cache': {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'network_info': u'[]', u'deleted_at': None, u'id': 2}, u'hostname': u'inst2-lh-vol', u'launched_on': None, u'display_description': u'inst2-LH-vol', u'key_data': u'ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQDR+WJJaonpQSdI5RkuY43pSlYigENx9/mRjTfpxxJ2JN8oP44m9lnpKGLG5KhaOL5wcgvdO7AhvudQwgYkK0SA7wNtWaJFZ6U71XF6CbPXfw00tEs8dV49+UWsxHk0K+nenTjCQsdwNCJtP4yAoEbHNUkqF0fFHrnfnPhdPLASKwPnaFIXsRA01ZrAg9KD4Xep/bCIDb6jQ4pzDEDZYv5+aIeWd5AqEpR0GiyWxJJCCPWgEvmU9uVfOsZUqv+USNnDxavVc+X48H8G+gyhExB5JwQ7A/0TljriXRLguk43PnRfPDghE2by3f66mI/nMuGmzQFN94oApsrG13NV0UxL stack@devstack01\n', u'kernel_id': u'', u'power_state': 0, u'default_ephemeral_device': None, u'progress': 0, u'project_id': u'978c15471af74381b4a56984df6600b3', u'launched_at': None, u'scheduled_at': u'2014-03-13T15:23:29.433994', u'node': None, u'ramdisk_id': u'', u'access_ip_v6': None, u'access_ip_v4': None, u'deleted': 0, u'key_name': u'devstack', u'updated_at': u'2014-03-13T15:23:29.494868', u'host': None, u'ephemeral_key_uuid': None, u'architecture': None, u'display_name': u'inst2-LH-vol', u'system_metadata': [{u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'64', u'key': u'instance_type_memory_mb', u'deleted_at': None, u'id': 17}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'0', u'key': u'instance_type_swap', u'deleted_at': None, u'id': 18}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': None, u'key': u'instance_type_vcpu_weight', u'deleted_at': None, u'id': 19}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'0', u'key': u'instance_type_root_gb', u'deleted_at': None, u'id': 20}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'6', u'key': u'instance_type_id', u'deleted_at': None, u'id': 21}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'm1.nano', u'key': u'instance_type_name', u'deleted_at': None, u'id': 22}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'Ubuntu12_04', u'key': u'image_image_name', u'deleted_at': None, u'id': 23}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'0', u'key': u'instance_type_ephemeral_gb', u'deleted_at': None, u'id': 24}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'qcow2', u'key': u'image_disk_format', u'deleted_at': None, u'id': 25}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'1.0', u'key': u'instance_type_rxtx_factor', u'deleted_at': None, u'id': 26}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'bare', u'key': u'image_container_format', u'deleted_at': None, u'id': 27}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'a78b1876-b590-46f6-b952-a582cc4a9fe5', u'key': u'image_image_id', u'deleted_at': None, u'id': 28}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'42', u'key': u'instance_type_flavorid', u'deleted_at': None, u'id': 29}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'255328768', u'key': u'image_size', u'deleted_at': None, u'id': 30}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'1', u'key': u'instance_type_vcpus', u'deleted_at': None, u'id': 31}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'0', u'key': u'image_min_ram', u'deleted_at': None, u'id': 32}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'0', u'key': u'image_min_disk', u'deleted_at': None, u'id': 33}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'', u'key': u'image_base_image_ref', u'deleted_at': None, u'id': 34}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'8eb1e06aca4d7dcd3b945f9f818b2545', u'key': u'image_checksum', u'deleted_at': None, u'id': 35}], u'task_state': u'scheduling', u'shutdown_terminate': False, u'cell_name': None, u'root_gb': 0, u'locked': False, u'name': u'instance-00000002', u'created_at': u'2014-03-13T15:23:29.000000', u'locked_by': None, u'launch_index': 0, u'metadata': [], u'memory_mb': 64, u'vcpus': 1, u'image_ref': u'', u'root_device_name': None, u'auto_disk_config': True, u'os_type': None, u'config_drive': u''}, u'admin_password': '<SANITIZED>', u'injected_files': [], u'is_first_time': True}, u'_context_tenant': u'978c15471af74381b4a56984df6600b3', u'_context_user': u'78a306a768c345edadeaf2305eebf370', u'_context_auth_token': '<SANITIZED>', u'method': u'run_instance', u'_context_is_admin': True, u'version': u'3.0', u'_context_project_id': u'978c15471af74381b4a56984df6600b3', u'_context_timestamp': u'2014-03-13T15:23:28.850184', u'_unique_id': u'12dc70874a674ccd8a4ca2ca189953bb', u'_context_read_deleted': u'no', u'_context_user_id': u'78a306a768c345edadeaf2305eebf370', u'_context_user_name': u'admin', u'_context_remote_address': u'10.50.128.11'} from (pid=21675) _safe_log /opt/stack/oslo.messaging/oslo/messaging/_drivers/common.py:290
2014-03-13 08:23:29.512 DEBUG oslo.messaging._drivers.amqp [-] unpacked context: {'tenant': u'978c15471af74381b4a56984df6600b3', 'project_name': u'demo', 'user_id': u'78a306a768c345edadeaf2305eebf370', 'roles': [u'admin'], 'timestamp': u'2014-03-13T15:23:28.850184', 'auth_token': '<SANITIZED>', 'remote_address': u'10.50.128.11', 'quota_class': None, 'is_admin': True, 'user': u'78a306a768c345edadeaf2305eebf370', 'service_catalog': [{u'endpoints_links': [], u'endpoints': [{u'adminURL': u'http://10.50.128.11:8776/v1/978c15471af74381b4a56984df6600b3', u'region': u'RegionOne', u'id': u'0699c811d8534cbdb944271c2ed62d93', u'serviceName': u'cinder', u'internalURL': u'http://10.50.128.11:8776/v1/978c15471af74381b4a56984df6600b3', u'publicURL': u'http://10.50.128.11:8776/v1/978c15471af74381b4a56984df6600b3'}], u'type': u'volume', u'name': u'cinder'}], 'request_id': u'req-b142be5e-9765-4743-bd7d-fda16220cb33', 'instance_lock_checked': False, 'project_id': u'978c15471af74381b4a56984df6600b3', 'user_name': u'admin', 'read_deleted': u'no'} from (pid=21675) _safe_log /opt/stack/oslo.messaging/oslo/messaging/_drivers/common.py:290
2014-03-13 08:23:29.517 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is 91dd550a748247e9b58027bf1aee8bea from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:23:29.517 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is ed169376a1f6412fa152056aa3e2ee8d. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:23:29.536 DEBUG nova.openstack.common.lockutils [req-b142be5e-9765-4743-bd7d-fda16220cb33 admin demo] Got semaphore "a913af99-46e1-4425-9fc1-feba5ebcc84d" from (pid=21675) lock /opt/stack/nova/nova/openstack/common/lockutils.py:168
2014-03-13 08:23:29.536 DEBUG nova.openstack.common.lockutils [req-b142be5e-9765-4743-bd7d-fda16220cb33 admin demo] Got semaphore / lock "do_run_instance" from (pid=21675) inner /opt/stack/nova/nova/openstack/common/lockutils.py:248
2014-03-13 08:23:29.540 AUDIT nova.compute.manager [req-b142be5e-9765-4743-bd7d-fda16220cb33 admin demo] [instance: a913af99-46e1-4425-9fc1-feba5ebcc84d] Starting instance...
2014-03-13 08:23:29.541 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is fc77e1f06619489da22ae256c23efe45 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:23:29.541 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is cd3b1a9db10443bfabd33e5a910b25bd. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:23:29.627 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is d2938c3117244e878d5874b6e226f23d from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:23:29.627 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 3ad540d17eab4453aa33c5f319170988. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:23:29.704 DEBUG nova.openstack.common.lockutils [req-b142be5e-9765-4743-bd7d-fda16220cb33 admin demo] Semaphore / lock released "do_run_instance" from (pid=21675) inner /opt/stack/nova/nova/openstack/common/lockutils.py:252
2014-03-13 08:23:29.705 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is afb51969e04a446a817eadb140161684 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:23:29.705 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 395e0c6267924393a0a69a03c75c0fdf. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:23:29.725 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is 0b908d174189411c9196ce58e3935f37 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:23:29.726 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is b1ea0792023241218f38d30cc17e1bd1. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:23:29.756 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is 6f4eb792f7bc46f7835c3dae74ae9dc8 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:23:29.756 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is ae08a1cd972745bda36a54e9b642f979. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:23:29.837 ERROR oslo.messaging.rpc.dispatcher [-] Exception during message handling: 'name'
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher Traceback (most recent call last):
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/oslo.messaging/oslo/messaging/rpc/dispatcher.py", line 133, in _dispatch_and_reply
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     incoming.message))
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/oslo.messaging/oslo/messaging/rpc/dispatcher.py", line 176, in _dispatch
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     return self._do_dispatch(endpoint, method, ctxt, args)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/oslo.messaging/oslo/messaging/rpc/dispatcher.py", line 122, in _do_dispatch
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     result = getattr(endpoint, method)(ctxt, **new_args)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/exception.py", line 88, in wrapped
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     payload)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     six.reraise(self.type_, self.value, self.tb)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/exception.py", line 71, in wrapped
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     return f(self, context, *args, **kw)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 243, in decorated_function
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     pass
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     six.reraise(self.type_, self.value, self.tb)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 229, in decorated_function
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     return function(self, context, *args, **kwargs)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 294, in decorated_function
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     function(self, context, *args, **kwargs)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 271, in decorated_function
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     e, sys.exc_info())
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     six.reraise(self.type_, self.value, self.tb)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 258, in decorated_function
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     return function(self, context, *args, **kwargs)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 1858, in run_instance
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     do_run_instance()
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/openstack/common/lockutils.py", line 249, in inner
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     return f(*args, **kwargs)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 1857, in do_run_instance
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     legacy_bdm_in_spec)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 999, in _run_instance
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     notify("error", msg=unicode(e))  # notify that build failed
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     six.reraise(self.type_, self.value, self.tb)
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 974, in _run_instance
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     extra_usage_info = {"image_name": image_meta['name']}
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher KeyError: 'name'
2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher
2014-03-13 08:23:29.839 ERROR oslo.messaging._drivers.common [-] Returning exception 'name' to caller
2014-03-13 08:23:29.839 ERROR oslo.messaging._drivers.common [-] ['Traceback (most recent call last):\n', '  File "/opt/stack/oslo.messaging/oslo/messaging/rpc/dispatcher.py", line 133, in _dispatch_and_reply\n    incoming.message))\n', '  File "/opt/stack/oslo.messaging/oslo/messaging/rpc/dispatcher.py", line 176, in _dispatch\n    return self._do_dispatch(endpoint, method, ctxt, args)\n', '  File "/opt/stack/oslo.messaging/oslo/messaging/rpc/dispatcher.py", line 122, in _do_dispatch\n    result = getattr(endpoint, method)(ctxt, **new_args)\n', '  File "/opt/stack/nova/nova/exception.py", line 88, in wrapped\n    payload)\n', '  File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__\n    six.reraise(self.type_, self.value, self.tb)\n', '  File "/opt/stack/nova/nova/exception.py", line 71, in wrapped\n    return f(self, context, *args, **kw)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 243, in decorated_function\n    pass\n', '  File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__\n    six.reraise(self.type_, self.value, self.tb)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 229, in decorated_function\n    return function(self, context, *args, **kwargs)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 294, in decorated_function\n    function(self, context, *args, **kwargs)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 271, in decorated_function\n    e, sys.exc_info())\n', '  File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__\n    six.reraise(self.type_, self.value, self.tb)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 258, in decorated_function\n    return function(self, context, *args, **kwargs)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 1858, in run_instance\n    do_run_instance()\n', '  File "/opt/stack/nova/nova/openstack/common/lockutils.py", line 249, in inner\n    return f(*args, **kwargs)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 1857, in do_run_instance\n    legacy_bdm_in_spec)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 999, in _run_instance\n    notify("error", msg=unicode(e))  # notify that build failed\n', '  File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__\n    six.reraise(self.type_, self.value, self.tb)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 974, in _run_instance\n    extra_usage_info = {"image_name": image_meta[\'name\']}\n', "KeyError: 'name'\n"]
2014-03-13 08:23:29.839 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is b6f9cda197f34d64ac747a3f1001899a. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
2014-03-13 08:23:29.840 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 7b18ab5b38e740f9a611779e53f6fd19. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
^A"^[[A^[[A^[[A^A[^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A2014-03-13 08:23:37.470 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is 15506b31d9f34a098dc4c996aa419e58 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
2014-03-13 08:23:37.471 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is d657fb636f7d4e8ab7ef2

** Affects: nova
     Importance: Undecided
         Status: Confirmed

-- 
You received this bug notification because you are a member of Yahoo!
Engineering Team, which is subscribed to OpenStack Compute (nova).
https://bugs.launchpad.net/bugs/1292139

Title:
  nova boot from volume fails nova/compute/manager.py KeyError: 'name'

Status in OpenStack Compute (Nova):
  Confirmed

Bug description:
  Running devstack master icehouse
  nova version 2.17.02

  
  cinder list
  +--------------------------------------+-----------+-----------------+------+-------------+----------+-------------+
  |                  ID                  |   Status  |   Display Name  | Size | Volume Type | Bootable | Attached to |
  +--------------------------------------+-----------+-----------------+------+-------------+----------+-------------+
  | a2d1e94f-1eed-4a93-9bbd-4994449482c1 | available | 11-LH-vol-image |  40  |   lefthand  |   true   |             |
  +--------------------------------------+-----------+-----------------+------+-------------+----------+-------------+

  
  nova boot --flavor 1 --boot-volume a2d1e94f-1eed-4a93-9bbd-4994449482c 77-inst-vol-Lefthand-flav1

  TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 974, in _run_instance
  TRACE oslo.messaging.rpc.dispatcher     extra_usage_info = {"image_name": image_meta['name']}
  TRACE oslo.messaging.rpc.dispatcher KeyError: 'name'

  
  2014-03-13 08:22:50.849 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is ade60d8576b34d99876d649eac10598b from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:22:50.849 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is c1fc84e4e9024a86badc0fe46b6e8028. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:22:50.867 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is ef94d991c0f443f6a99c8efd02d9f065 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:22:50.867 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 05de1846140c46afaec5ecf7957be384. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:22:50.905 AUDIT nova.compute.resource_tracker [-] Free ram (MB): 96137
  2014-03-13 08:22:50.905 AUDIT nova.compute.resource_tracker [-] Free disk (GB): 180
  2014-03-13 08:22:50.906 AUDIT nova.compute.resource_tracker [-] Free VCPUS: 32
  2014-03-13 08:22:50.906 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is bfda17d193bd4591b340f474f584f80e from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:22:50.907 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 5c6b1c34e2774c05b1b5288632d995bf. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:22:50.935 INFO nova.compute.resource_tracker [-] Compute_service record updated for cld2b9:cld2b9
  2014-03-13 08:22:50.935 DEBUG nova.openstack.common.lockutils [-] Semaphore / lock released "update_available_resource" from (pid=21675) inner /opt/stack/nova/nova/openstack/common/lockutils.py:252
  2014-03-13 08:22:50.936 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is cc8ee588d31d49348917383703201705 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:22:50.936 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is b07b07e333fe484aa8574ee584fc68c8. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:22:50.968 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._poll_rebooting_instances from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
  2014-03-13 08:22:50.969 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._cleanup_running_deleted_instances from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
  2014-03-13 08:22:50.980 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is d15f259dbba847dd932f355b5a0c0c22 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:22:50.980 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 81adf43fdc5d41359fbb560d4ca3c04e. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:22:51.007 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._reclaim_queued_deletes from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
  2014-03-13 08:22:51.007 DEBUG nova.compute.manager [-] CONF.reclaim_instance_interval <= 0, skipping... from (pid=21675) _reclaim_queued_deletes /opt/stack/nova/nova/compute/manager.py:5067
  2014-03-13 08:22:51.007 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._poll_unconfirmed_resizes from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
  2014-03-13 08:22:51.008 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._poll_rescued_instances from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
  2014-03-13 08:22:51.008 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._poll_shelved_instances from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
  2014-03-13 08:22:51.009 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._check_instance_build_time from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
  2014-03-13 08:22:51.009 DEBUG nova.openstack.common.periodic_task [-] Running periodic task ComputeManager._heal_instance_info_cache from (pid=21675) run_periodic_tasks /opt/stack/nova/nova/openstack/common/periodic_task.py:178
  2014-03-13 08:22:51.009 DEBUG nova.openstack.common.loopingcall [-] Dynamic looping call sleeping for 60.00 seconds from (pid=21675) _inner /opt/stack/nova/nova/openstack/common/loopingcall.py:132
  2014-03-13 08:22:57.460 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is 1d674d267f1446318b11fce3d1d7acd8 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:22:57.460 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is ecf715aa42264799a952270e5ab472a9. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:23:07.462 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is 709253c5a695494097d4e9ee3f09c942 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:23:07.463 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 2cc24381bd224cea81b8cf3698dd2c56. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:23:17.466 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is aac959cfd171485eba63532cfa5920cc from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:23:17.466 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 95fab99733dd4b0bb09222e19f1f8ec7. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:23:27.466 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is ade8e7bb73fc49c0996c5a515cdd6aed from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:23:27.466 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is c326b1efdd5f44d98a91327a786cb446. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:23:29.511 DEBUG oslo.messaging._drivers.amqpdriver [-] received {u'_context_roles': [u'admin'], u'_context_request_id': u'req-b142be5e-9765-4743-bd7d-fda16220cb33', u'_context_quota_class': None, u'_context_instance_lock_checked': False, u'_context_project_name': u'demo', u'_context_service_catalog': [{u'endpoints': [{u'adminURL': u'http://10.50.128.11:8776/v1/978c15471af74381b4a56984df6600b3', u'region': u'RegionOne', u'internalURL': u'http://10.50.128.11:8776/v1/978c15471af74381b4a56984df6600b3', u'serviceName': u'cinder', u'id': u'0699c811d8534cbdb944271c2ed62d93', u'publicURL': u'http://10.50.128.11:8776/v1/978c15471af74381b4a56984df6600b3'}], u'endpoints_links': [], u'type': u'volume', u'name': u'cinder'}], u'args': {u'node': u'cld2b9', u'legacy_bdm_in_spec': False, u'request_spec': {u'num_instances': 1, u'block_device_mapping': [{u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'boot_index': 0, u'no_device': None, u'connection_info': None, u'image_id': None, u'volume_id': u'a2d1e94f-1eed-4a93-9bbd-4994449482c1', u'device_name': u'vda', u'volume_size': None, u'source_type': u'volume', u'snapshot_id': None, u'destination_type': u'volume', u'delete_on_termination': False}], u'image': {u'properties': {u'container_format': u'bare', u'min_ram': u'0', u'disk_format': u'qcow2', u'image_name': u'Ubuntu12_04', u'image_id': u'a78b1876-b590-46f6-b952-a582cc4a9fe5', u'checksum': u'8eb1e06aca4d7dcd3b945f9f818b2545', u'min_disk': u'0', u'size': u'255328768'}}, u'instance_type': {u'root_gb': 0, u'name': u'm1.nano', u'ephemeral_gb': 0, u'memory_mb': 64, u'vcpus': 1, u'extra_specs': {}, u'swap': 0, u'rxtx_factor': 1.0, u'flavorid': u'42', u'vcpu_weight': None, u'id': 6}, u'instance_properties': {u'vm_state': u'building', u'availability_zone': u'nova', u'terminated_at': None, u'ephemeral_gb': 0, u'instance_type_id': 6, u'user_data': None, u'cleaned': False, u'vm_mode': None, u'deleted_at': None, u'reservation_id': u'r-y0mn6obr', u'id': 2, u'security_groups': [{u'project_id': u'978c15471af74381b4a56984df6600b3', u'user_id': u'78a306a768c345edadeaf2305eebf370', u'description': u'default', u'deleted': False, u'created_at': u'2014-03-13T15:15:52.000000', u'updated_at': None, u'deleted_at': None, u'id': 1, u'name': u'default'}], u'disable_terminate': False, u'display_name': u'inst2-LH-vol', u'uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'default_swap_device': None, u'info_cache': {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': False, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'network_info': [], u'deleted_at': None}, u'hostname': u'inst2-lh-vol', u'launched_on': None, u'display_description': u'inst2-LH-vol', u'key_data': u'ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQDR+WJJaonpQSdI5RkuY43pSlYigENx9/mRjTfpxxJ2JN8oP44m9lnpKGLG5KhaOL5wcgvdO7AhvudQwgYkK0SA7wNtWaJFZ6U71XF6CbPXfw00tEs8dV49+UWsxHk0K+nenTjCQsdwNCJtP4yAoEbHNUkqF0fFHrnfnPhdPLASKwPnaFIXsRA01ZrAg9KD4Xep/bCIDb6jQ4pzDEDZYv5+aIeWd5AqEpR0GiyWxJJCCPWgEvmU9uVfOsZUqv+USNnDxavVc+X48H8G+gyhExB5JwQ7A/0TljriXRLguk43PnRfPDghE2by3f66mI/nMuGmzQFN94oApsrG13NV0UxL stack@devstack01\n', u'kernel_id': u'', u'power_state': 0, u'default_ephemeral_device': None, u'progress': 0, u'project_id': u'978c15471af74381b4a56984df6600b3', u'launched_at': None, u'config_drive': u'', u'node': None, u'ramdisk_id': u'', u'access_ip_v6': None, u'access_ip_v4': None, u'deleted': False, u'key_name': u'devstack', u'updated_at': None, u'host': None, u'ephemeral_key_uuid': None, u'architecture': None, u'user_id': u'78a306a768c345edadeaf2305eebf370', u'system_metadata': {u'instance_type_memory_mb': u'64', u'instance_type_swap': u'0', u'image_base_image_ref': u'', u'instance_type_vcpu_weight': None, u'instance_type_root_gb': u'0', u'instance_type_id': u'6', u'instance_type_name': u'm1.nano', u'image_image_name': u'Ubuntu12_04', u'instance_type_ephemeral_gb': u'0', u'image_disk_format': u'qcow2', u'instance_type_rxtx_factor': u'1.0', u'image_container_format': u'bare', u'image_image_id': u'a78b1876-b590-46f6-b952-a582cc4a9fe5', u'instance_type_flavorid': u'42', u'image_size': u'255328768', u'instance_type_vcpus': u'1', u'image_min_ram': u'0', u'image_min_disk': u'0', u'image_checksum': u'8eb1e06aca4d7dcd3b945f9f818b2545'}, u'task_state': u'scheduling', u'shutdown_terminate': False, u'cell_name': None, u'root_gb': 0, u'locked': False, u'name': u'instance-00000002', u'created_at': u'2014-03-13T15:23:29.000000', u'locked_by': None, u'launch_index': 0, u'metadata': {}, u'memory_mb': 64, u'vcpus': 1, u'image_ref': u'', u'root_device_name': None, u'auto_disk_config': True, u'os_type': None, u'scheduled_at': None}, u'security_group': [u'default'], u'instance_uuids': [u'a913af99-46e1-4425-9fc1-feba5ebcc84d']}, u'requested_networks': None, u'filter_properties': {u'config_options': {}, u'limits': {u'memory_mb': 144973.5}, u'request_spec': {u'num_instances': 1, u'block_device_mapping': [{u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'boot_index': 0, u'no_device': None, u'connection_info': None, u'image_id': None, u'volume_id': u'a2d1e94f-1eed-4a93-9bbd-4994449482c1', u'device_name': u'vda', u'volume_size': None, u'source_type': u'volume', u'snapshot_id': None, u'destination_type': u'volume', u'delete_on_termination': False}], u'image': {u'properties': {u'container_format': u'bare', u'min_ram': u'0', u'disk_format': u'qcow2', u'image_name': u'Ubuntu12_04', u'image_id': u'a78b1876-b590-46f6-b952-a582cc4a9fe5', u'checksum': u'8eb1e06aca4d7dcd3b945f9f818b2545', u'min_disk': u'0', u'size': u'255328768'}}, u'instance_type': {u'root_gb': 0, u'name': u'm1.nano', u'ephemeral_gb': 0, u'memory_mb': 64, u'vcpus': 1, u'extra_specs': {}, u'swap': 0, u'rxtx_factor': 1.0, u'flavorid': u'42', u'vcpu_weight': None, u'id': 6}, u'instance_properties': {u'vm_state': u'building', u'availability_zone': u'nova', u'terminated_at': None, u'ephemeral_gb': 0, u'instance_type_id': 6, u'user_data': None, u'cleaned': False, u'vm_mode': None, u'deleted_at': None, u'reservation_id': u'r-y0mn6obr', u'id': 2, u'security_groups': [{u'project_id': u'978c15471af74381b4a56984df6600b3', u'user_id': u'78a306a768c345edadeaf2305eebf370', u'description': u'default', u'deleted': False, u'created_at': u'2014-03-13T15:15:52.000000', u'updated_at': None, u'deleted_at': None, u'id': 1, u'name': u'default'}], u'disable_terminate': False, u'display_name': u'inst2-LH-vol', u'uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'default_swap_device': None, u'info_cache': {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': False, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'network_info': [], u'deleted_at': None}, u'hostname': u'inst2-lh-vol', u'launched_on': None, u'display_description': u'inst2-LH-vol', u'key_data': u'ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQDR+WJJaonpQSdI5RkuY43pSlYigENx9/mRjTfpxxJ2JN8oP44m9lnpKGLG5KhaOL5wcgvdO7AhvudQwgYkK0SA7wNtWaJFZ6U71XF6CbPXfw00tEs8dV49+UWsxHk0K+nenTjCQsdwNCJtP4yAoEbHNUkqF0fFHrnfnPhdPLASKwPnaFIXsRA01ZrAg9KD4Xep/bCIDb6jQ4pzDEDZYv5+aIeWd5AqEpR0GiyWxJJCCPWgEvmU9uVfOsZUqv+USNnDxavVc+X48H8G+gyhExB5JwQ7A/0TljriXRLguk43PnRfPDghE2by3f66mI/nMuGmzQFN94oApsrG13NV0UxL stack@devstack01\n', u'kernel_id': u'', u'power_state': 0, u'default_ephemeral_device': None, u'progress': 0, u'project_id': u'978c15471af74381b4a56984df6600b3', u'launched_at': None, u'config_drive': u'', u'node': None, u'ramdisk_id': u'', u'access_ip_v6': None, u'access_ip_v4': None, u'deleted': False, u'key_name': u'devstack', u'updated_at': None, u'host': None, u'ephemeral_key_uuid': None, u'architecture': None, u'user_id': u'78a306a768c345edadeaf2305eebf370', u'system_metadata': {u'instance_type_memory_mb': u'64', u'instance_type_swap': u'0', u'image_base_image_ref': u'', u'instance_type_vcpu_weight': None, u'instance_type_root_gb': u'0', u'instance_type_id': u'6', u'instance_type_name': u'm1.nano', u'image_image_name': u'Ubuntu12_04', u'instance_type_ephemeral_gb': u'0', u'image_disk_format': u'qcow2', u'instance_type_rxtx_factor': u'1.0', u'image_container_format': u'bare', u'image_image_id': u'a78b1876-b590-46f6-b952-a582cc4a9fe5', u'instance_type_flavorid': u'42', u'image_size': u'255328768', u'instance_type_vcpus': u'1', u'image_min_ram': u'0', u'image_min_disk': u'0', u'image_checksum': u'8eb1e06aca4d7dcd3b945f9f818b2545'}, u'task_state': u'scheduling', u'shutdown_terminate': False, u'cell_name': None, u'root_gb': 0, u'locked': False, u'name': u'instance-00000002', u'created_at': u'2014-03-13T15:23:29.000000', u'locked_by': None, u'launch_index': 0, u'metadata': {}, u'memory_mb': 64, u'vcpus': 1, u'image_ref': u'', u'root_device_name': None, u'auto_disk_config': True, u'os_type': None, u'scheduled_at': None}, u'security_group': [u'default'], u'instance_uuids': [u'a913af99-46e1-4425-9fc1-feba5ebcc84d']}, u'instance_type': {u'root_gb': 0, u'name': u'm1.nano', u'ephemeral_gb': 0, u'memory_mb': 64, u'vcpus': 1, u'extra_specs': {}, u'swap': 0, u'rxtx_factor': 1.0, u'flavorid': u'42', u'vcpu_weight': None, u'id': 6}, u'retry': {u'num_attempts': 1, u'hosts': [[u'cld2b9', u'cld2b9']]}, u'os_type': None, u'project_id': u'978c15471af74381b4a56984df6600b3', u'scheduler_hints': {}}, u'instance': {u'vm_state': u'building', u'internal_id': None, u'availability_zone': u'nova', u'terminated_at': None, u'ephemeral_gb': 0, u'instance_type_id': 6, u'user_data': None, u'cleaned': 0, u'vm_mode': None, u'deleted_at': None, u'reservation_id': u'r-y0mn6obr', u'id': 2, u'security_groups': [{u'deleted_at': None, u'user_id': u'78a306a768c345edadeaf2305eebf370', u'name': u'default', u'deleted': 0, u'created_at': u'2014-03-13T15:15:52.000000', u'updated_at': None, u'rules': [], u'project_id': u'978c15471af74381b4a56984df6600b3', u'id': 1, u'description': u'default'}], u'disable_terminate': False, u'user_id': u'78a306a768c345edadeaf2305eebf370', u'uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'default_swap_device': None, u'info_cache': {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'network_info': u'[]', u'deleted_at': None, u'id': 2}, u'hostname': u'inst2-lh-vol', u'launched_on': None, u'display_description': u'inst2-LH-vol', u'key_data': u'ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQDR+WJJaonpQSdI5RkuY43pSlYigENx9/mRjTfpxxJ2JN8oP44m9lnpKGLG5KhaOL5wcgvdO7AhvudQwgYkK0SA7wNtWaJFZ6U71XF6CbPXfw00tEs8dV49+UWsxHk0K+nenTjCQsdwNCJtP4yAoEbHNUkqF0fFHrnfnPhdPLASKwPnaFIXsRA01ZrAg9KD4Xep/bCIDb6jQ4pzDEDZYv5+aIeWd5AqEpR0GiyWxJJCCPWgEvmU9uVfOsZUqv+USNnDxavVc+X48H8G+gyhExB5JwQ7A/0TljriXRLguk43PnRfPDghE2by3f66mI/nMuGmzQFN94oApsrG13NV0UxL stack@devstack01\n', u'kernel_id': u'', u'power_state': 0, u'default_ephemeral_device': None, u'progress': 0, u'project_id': u'978c15471af74381b4a56984df6600b3', u'launched_at': None, u'scheduled_at': u'2014-03-13T15:23:29.433994', u'node': None, u'ramdisk_id': u'', u'access_ip_v6': None, u'access_ip_v4': None, u'deleted': 0, u'key_name': u'devstack', u'updated_at': u'2014-03-13T15:23:29.494868', u'host': None, u'ephemeral_key_uuid': None, u'architecture': None, u'display_name': u'inst2-LH-vol', u'system_metadata': [{u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'64', u'key': u'instance_type_memory_mb', u'deleted_at': None, u'id': 17}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'0', u'key': u'instance_type_swap', u'deleted_at': None, u'id': 18}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': None, u'key': u'instance_type_vcpu_weight', u'deleted_at': None, u'id': 19}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'0', u'key': u'instance_type_root_gb', u'deleted_at': None, u'id': 20}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'6', u'key': u'instance_type_id', u'deleted_at': None, u'id': 21}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'm1.nano', u'key': u'instance_type_name', u'deleted_at': None, u'id': 22}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'Ubuntu12_04', u'key': u'image_image_name', u'deleted_at': None, u'id': 23}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'0', u'key': u'instance_type_ephemeral_gb', u'deleted_at': None, u'id': 24}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'qcow2', u'key': u'image_disk_format', u'deleted_at': None, u'id': 25}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'1.0', u'key': u'instance_type_rxtx_factor', u'deleted_at': None, u'id': 26}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'bare', u'key': u'image_container_format', u'deleted_at': None, u'id': 27}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'a78b1876-b590-46f6-b952-a582cc4a9fe5', u'key': u'image_image_id', u'deleted_at': None, u'id': 28}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'42', u'key': u'instance_type_flavorid', u'deleted_at': None, u'id': 29}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'255328768', u'key': u'image_size', u'deleted_at': None, u'id': 30}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'1', u'key': u'instance_type_vcpus', u'deleted_at': None, u'id': 31}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'0', u'key': u'image_min_ram', u'deleted_at': None, u'id': 32}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'0', u'key': u'image_min_disk', u'deleted_at': None, u'id': 33}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'', u'key': u'image_base_image_ref', u'deleted_at': None, u'id': 34}, {u'instance_uuid': u'a913af99-46e1-4425-9fc1-feba5ebcc84d', u'deleted': 0, u'created_at': u'2014-03-13T15:23:29.000000', u'updated_at': None, u'value': u'8eb1e06aca4d7dcd3b945f9f818b2545', u'key': u'image_checksum', u'deleted_at': None, u'id': 35}], u'task_state': u'scheduling', u'shutdown_terminate': False, u'cell_name': None, u'root_gb': 0, u'locked': False, u'name': u'instance-00000002', u'created_at': u'2014-03-13T15:23:29.000000', u'locked_by': None, u'launch_index': 0, u'metadata': [], u'memory_mb': 64, u'vcpus': 1, u'image_ref': u'', u'root_device_name': None, u'auto_disk_config': True, u'os_type': None, u'config_drive': u''}, u'admin_password': '<SANITIZED>', u'injected_files': [], u'is_first_time': True}, u'_context_tenant': u'978c15471af74381b4a56984df6600b3', u'_context_user': u'78a306a768c345edadeaf2305eebf370', u'_context_auth_token': '<SANITIZED>', u'method': u'run_instance', u'_context_is_admin': True, u'version': u'3.0', u'_context_project_id': u'978c15471af74381b4a56984df6600b3', u'_context_timestamp': u'2014-03-13T15:23:28.850184', u'_unique_id': u'12dc70874a674ccd8a4ca2ca189953bb', u'_context_read_deleted': u'no', u'_context_user_id': u'78a306a768c345edadeaf2305eebf370', u'_context_user_name': u'admin', u'_context_remote_address': u'10.50.128.11'} from (pid=21675) _safe_log /opt/stack/oslo.messaging/oslo/messaging/_drivers/common.py:290
  2014-03-13 08:23:29.512 DEBUG oslo.messaging._drivers.amqp [-] unpacked context: {'tenant': u'978c15471af74381b4a56984df6600b3', 'project_name': u'demo', 'user_id': u'78a306a768c345edadeaf2305eebf370', 'roles': [u'admin'], 'timestamp': u'2014-03-13T15:23:28.850184', 'auth_token': '<SANITIZED>', 'remote_address': u'10.50.128.11', 'quota_class': None, 'is_admin': True, 'user': u'78a306a768c345edadeaf2305eebf370', 'service_catalog': [{u'endpoints_links': [], u'endpoints': [{u'adminURL': u'http://10.50.128.11:8776/v1/978c15471af74381b4a56984df6600b3', u'region': u'RegionOne', u'id': u'0699c811d8534cbdb944271c2ed62d93', u'serviceName': u'cinder', u'internalURL': u'http://10.50.128.11:8776/v1/978c15471af74381b4a56984df6600b3', u'publicURL': u'http://10.50.128.11:8776/v1/978c15471af74381b4a56984df6600b3'}], u'type': u'volume', u'name': u'cinder'}], 'request_id': u'req-b142be5e-9765-4743-bd7d-fda16220cb33', 'instance_lock_checked': False, 'project_id': u'978c15471af74381b4a56984df6600b3', 'user_name': u'admin', 'read_deleted': u'no'} from (pid=21675) _safe_log /opt/stack/oslo.messaging/oslo/messaging/_drivers/common.py:290
  2014-03-13 08:23:29.517 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is 91dd550a748247e9b58027bf1aee8bea from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:23:29.517 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is ed169376a1f6412fa152056aa3e2ee8d. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:23:29.536 DEBUG nova.openstack.common.lockutils [req-b142be5e-9765-4743-bd7d-fda16220cb33 admin demo] Got semaphore "a913af99-46e1-4425-9fc1-feba5ebcc84d" from (pid=21675) lock /opt/stack/nova/nova/openstack/common/lockutils.py:168
  2014-03-13 08:23:29.536 DEBUG nova.openstack.common.lockutils [req-b142be5e-9765-4743-bd7d-fda16220cb33 admin demo] Got semaphore / lock "do_run_instance" from (pid=21675) inner /opt/stack/nova/nova/openstack/common/lockutils.py:248
  2014-03-13 08:23:29.540 AUDIT nova.compute.manager [req-b142be5e-9765-4743-bd7d-fda16220cb33 admin demo] [instance: a913af99-46e1-4425-9fc1-feba5ebcc84d] Starting instance...
  2014-03-13 08:23:29.541 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is fc77e1f06619489da22ae256c23efe45 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:23:29.541 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is cd3b1a9db10443bfabd33e5a910b25bd. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:23:29.627 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is d2938c3117244e878d5874b6e226f23d from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:23:29.627 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 3ad540d17eab4453aa33c5f319170988. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:23:29.704 DEBUG nova.openstack.common.lockutils [req-b142be5e-9765-4743-bd7d-fda16220cb33 admin demo] Semaphore / lock released "do_run_instance" from (pid=21675) inner /opt/stack/nova/nova/openstack/common/lockutils.py:252
  2014-03-13 08:23:29.705 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is afb51969e04a446a817eadb140161684 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:23:29.705 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 395e0c6267924393a0a69a03c75c0fdf. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:23:29.725 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is 0b908d174189411c9196ce58e3935f37 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:23:29.726 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is b1ea0792023241218f38d30cc17e1bd1. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:23:29.756 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is 6f4eb792f7bc46f7835c3dae74ae9dc8 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:23:29.756 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is ae08a1cd972745bda36a54e9b642f979. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:23:29.837 ERROR oslo.messaging.rpc.dispatcher [-] Exception during message handling: 'name'
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher Traceback (most recent call last):
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/oslo.messaging/oslo/messaging/rpc/dispatcher.py", line 133, in _dispatch_and_reply
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     incoming.message))
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/oslo.messaging/oslo/messaging/rpc/dispatcher.py", line 176, in _dispatch
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     return self._do_dispatch(endpoint, method, ctxt, args)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/oslo.messaging/oslo/messaging/rpc/dispatcher.py", line 122, in _do_dispatch
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     result = getattr(endpoint, method)(ctxt, **new_args)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/exception.py", line 88, in wrapped
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     payload)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     six.reraise(self.type_, self.value, self.tb)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/exception.py", line 71, in wrapped
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     return f(self, context, *args, **kw)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 243, in decorated_function
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     pass
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     six.reraise(self.type_, self.value, self.tb)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 229, in decorated_function
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     return function(self, context, *args, **kwargs)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 294, in decorated_function
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     function(self, context, *args, **kwargs)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 271, in decorated_function
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     e, sys.exc_info())
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     six.reraise(self.type_, self.value, self.tb)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 258, in decorated_function
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     return function(self, context, *args, **kwargs)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 1858, in run_instance
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     do_run_instance()
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/openstack/common/lockutils.py", line 249, in inner
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     return f(*args, **kwargs)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 1857, in do_run_instance
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     legacy_bdm_in_spec)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 999, in _run_instance
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     notify("error", msg=unicode(e))  # notify that build failed
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     six.reraise(self.type_, self.value, self.tb)
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher   File "/opt/stack/nova/nova/compute/manager.py", line 974, in _run_instance
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher     extra_usage_info = {"image_name": image_meta['name']}
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher KeyError: 'name'
  2014-03-13 08:23:29.837 TRACE oslo.messaging.rpc.dispatcher
  2014-03-13 08:23:29.839 ERROR oslo.messaging._drivers.common [-] Returning exception 'name' to caller
  2014-03-13 08:23:29.839 ERROR oslo.messaging._drivers.common [-] ['Traceback (most recent call last):\n', '  File "/opt/stack/oslo.messaging/oslo/messaging/rpc/dispatcher.py", line 133, in _dispatch_and_reply\n    incoming.message))\n', '  File "/opt/stack/oslo.messaging/oslo/messaging/rpc/dispatcher.py", line 176, in _dispatch\n    return self._do_dispatch(endpoint, method, ctxt, args)\n', '  File "/opt/stack/oslo.messaging/oslo/messaging/rpc/dispatcher.py", line 122, in _do_dispatch\n    result = getattr(endpoint, method)(ctxt, **new_args)\n', '  File "/opt/stack/nova/nova/exception.py", line 88, in wrapped\n    payload)\n', '  File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__\n    six.reraise(self.type_, self.value, self.tb)\n', '  File "/opt/stack/nova/nova/exception.py", line 71, in wrapped\n    return f(self, context, *args, **kw)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 243, in decorated_function\n    pass\n', '  File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__\n    six.reraise(self.type_, self.value, self.tb)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 229, in decorated_function\n    return function(self, context, *args, **kwargs)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 294, in decorated_function\n    function(self, context, *args, **kwargs)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 271, in decorated_function\n    e, sys.exc_info())\n', '  File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__\n    six.reraise(self.type_, self.value, self.tb)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 258, in decorated_function\n    return function(self, context, *args, **kwargs)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 1858, in run_instance\n    do_run_instance()\n', '  File "/opt/stack/nova/nova/openstack/common/lockutils.py", line 249, in inner\n    return f(*args, **kwargs)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 1857, in do_run_instance\n    legacy_bdm_in_spec)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 999, in _run_instance\n    notify("error", msg=unicode(e))  # notify that build failed\n', '  File "/opt/stack/nova/nova/openstack/common/excutils.py", line 68, in __exit__\n    six.reraise(self.type_, self.value, self.tb)\n', '  File "/opt/stack/nova/nova/compute/manager.py", line 974, in _run_instance\n    extra_usage_info = {"image_name": image_meta[\'name\']}\n', "KeyError: 'name'\n"]
  2014-03-13 08:23:29.839 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is b6f9cda197f34d64ac747a3f1001899a. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  2014-03-13 08:23:29.840 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is 7b18ab5b38e740f9a611779e53f6fd19. from (pid=21675) _add_unique_id /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqp.py:338
  ^A"^[[A^[[A^[[A^A[^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A^[[A2014-03-13 08:23:37.470 DEBUG oslo.messaging._drivers.amqpdriver [-] MSG_ID is 15506b31d9f34a098dc4c996aa419e58 from (pid=21675) _send /opt/stack/oslo.messaging/oslo/messaging/_drivers/amqpdriver.py:377
  2014-03-13 08:23:37.471 DEBUG oslo.messaging._drivers.amqp [-] UNIQUE_ID is d657fb636f7d4e8ab7ef2

To manage notifications about this bug go to:
https://bugs.launchpad.net/nova/+bug/1292139/+subscriptions


Follow ups

References