Jan 26 19:39:51.808295 np0005596550.novalocal devstack@n-api-meta.service[181171]: DEBUG nova.api.metadata.handler [None req-5b5ff93d-401e-448e-94d3-f343f85b1465 None None] Metadata request headers: {'Host': '38.102.83.18:8775', 'User-Agent': 'python-requests/2.32.5', 'Accept-Encoding': 'gzip, deflate', 'Accept': '*/*', 'Connection': 'keep-alive', 'X-Forwarded-For': '10.1.0.14', 'X-Instance-Id': '68ccf2a3-6b44-45c9-b1c6-7565bf3e3939', 'X-Tenant-Id': '4e1d83bf94ad4b91a77ae878058a270e', 'X-Instance-Id-Signature': 'aa16614cfb4f50cbe9d296051d8574e44920c7ead8fbe3bf679ce3ad3c0c78c1'} {{(pid=181171) __call__ /opt/stack/nova/nova/api/metadata/handler.py:109}}
Jan 26 19:39:51.811963 np0005596550.novalocal devstack@n-api-meta.service[181171]: DEBUG oslo_concurrency.lockutils [None req-83d62690-51e2-48a4-8163-086b8a3afb50 None None] Acquiring lock "3251f6c2-6687-4a3c-947a-2368b695f3b2" by "nova.context.set_target_cell.<locals>.get_or_set_cached_cell_and_set_connections" {{(pid=181171) inner /usr/local/lib/python3.12/site-packages/oslo_concurrency/lockutils.py:405}}
Jan 26 19:39:51.812094 np0005596550.novalocal devstack@n-api-meta.service[181171]: DEBUG oslo_concurrency.lockutils [None req-83d62690-51e2-48a4-8163-086b8a3afb50 None None] Lock "3251f6c2-6687-4a3c-947a-2368b695f3b2" acquired by "nova.context.set_target_cell.<locals>.get_or_set_cached_cell_and_set_connections" :: waited 0.000s {{(pid=181171) inner /usr/local/lib/python3.12/site-packages/oslo_concurrency/lockutils.py:410}}
Jan 26 19:39:51.812205 np0005596550.novalocal devstack@n-api-meta.service[181171]: DEBUG oslo_concurrency.lockutils [None req-83d62690-51e2-48a4-8163-086b8a3afb50 None None] Lock "3251f6c2-6687-4a3c-947a-2368b695f3b2" "released" by "nova.context.set_target_cell.<locals>.get_or_set_cached_cell_and_set_connections" :: held 0.000s {{(pid=181171) inner /usr/local/lib/python3.12/site-packages/oslo_concurrency/lockutils.py:424}}
Jan 26 19:39:51.826508 np0005596550.novalocal devstack@n-api-meta.service[181171]: WARNING neutronclient.v2_0.client [None req-83d62690-51e2-48a4-8163-086b8a3afb50 None None] The python binding code in neutronclient is deprecated in favor of OpenstackSDK, please use that as this will be removed in a future release.
Jan 26 19:39:51.995930 np0005596550.novalocal devstack@n-api-meta.service[181171]: [pid: 181171|app: 0|req: 2/3] 38.102.83.18 () {40 vars in 682 bytes} [Mon Jan 26 19:39:51 2026] GET /latest/meta-data/public-ipv4 => generated 12 bytes in 192 msecs (HTTP/1.1 200) 3 headers in 99 bytes (1 switches on core 0)
Jan 26 19:39:52.358851 np0005596550.novalocal devstack@n-api-meta.service[181170]: DEBUG nova.api.metadata.handler [None req-38f1dd8a-6227-48f2-a1af-459b51cfe6c1 None None] Metadata request headers: {'Host': '38.102.83.18:8775', 'User-Agent': 'python-requests/2.32.5', 'Accept-Encoding': 'gzip, deflate', 'Accept': '*/*', 'Connection': 'keep-alive', 'X-Forwarded-For': '10.1.0.14', 'X-Instance-Id': '68ccf2a3-6b44-45c9-b1c6-7565bf3e3939', 'X-Tenant-Id': '4e1d83bf94ad4b91a77ae878058a270e', 'X-Instance-Id-Signature': 'aa16614cfb4f50cbe9d296051d8574e44920c7ead8fbe3bf679ce3ad3c0c78c1', 'Content-Length': '100'} {{(pid=181170) __call__ /opt/stack/nova/nova/api/metadata/handler.py:109}}
Jan 26 19:39:52.360341 np0005596550.novalocal devstack@n-api-meta.service[181170]: DEBUG nova.api.metadata.handler [None req-38f1dd8a-6227-48f2-a1af-459b51cfe6c1 None None] Using cached metadata for instance 68ccf2a3-6b44-45c9-b1c6-7565bf3e3939 {{(pid=181170) get_metadata_by_instance_id /opt/stack/nova/nova/api/metadata/handler.py:84}}
Jan 26 19:39:52.363304 np0005596550.novalocal devstack@n-api-meta.service[181170]: DEBUG oslo_concurrency.lockutils [None req-a7e86e44-1a16-4cbf-841c-5883b952ed78 None None] Acquiring lock "3251f6c2-6687-4a3c-947a-2368b695f3b2" by "nova.context.set_target_cell.<locals>.get_or_set_cached_cell_and_set_connections" {{(pid=181170) inner /usr/local/lib/python3.12/site-packages/oslo_concurrency/lockutils.py:405}}
Jan 26 19:39:52.363382 np0005596550.novalocal devstack@n-api-meta.service[181170]: DEBUG oslo_concurrency.lockutils [None req-a7e86e44-1a16-4cbf-841c-5883b952ed78 None None] Lock "3251f6c2-6687-4a3c-947a-2368b695f3b2" acquired by "nova.context.set_target_cell.<locals>.get_or_set_cached_cell_and_set_connections" :: waited 0.000s {{(pid=181170) inner /usr/local/lib/python3.12/site-packages/oslo_concurrency/lockutils.py:410}}
Jan 26 19:39:52.363474 np0005596550.novalocal devstack@n-api-meta.service[181170]: DEBUG oslo_concurrency.lockutils [None req-a7e86e44-1a16-4cbf-841c-5883b952ed78 None None] Lock "3251f6c2-6687-4a3c-947a-2368b695f3b2" "released" by "nova.context.set_target_cell.<locals>.get_or_set_cached_cell_and_set_connections" :: held 0.000s {{(pid=181170) inner /usr/local/lib/python3.12/site-packages/oslo_concurrency/lockutils.py:424}}
Jan 26 19:39:52.377573 np0005596550.novalocal devstack@n-api-meta.service[181170]: DEBUG nova.objects.instance [None req-a7e86e44-1a16-4cbf-841c-5883b952ed78 None None] Lazy-loading 'system_metadata' on Instance uuid 68ccf2a3-6b44-45c9-b1c6-7565bf3e3939 {{(pid=181170) obj_load_attr /opt/stack/nova/nova/objects/instance.py:1148}}
Jan 26 19:39:52.420179 np0005596550.novalocal devstack@n-api-meta.service[181170]: [pid: 181170|app: 0|req: 2/4] 38.102.83.18 () {42 vars in 706 bytes} [Mon Jan 26 19:39:52 2026] POST /openstack/2013-10-17/password => generated 0 bytes in 62 msecs (HTTP/1.1 200) 3 headers in 97 bytes (1 switches on core 0)
Jan 26 19:40:01.811017 np0005596550.novalocal devstack@n-api-meta.service[181171]: DEBUG dbcounter [-] [181171] Writing DB stats nova_api:SELECT=1 {{(pid=181171) stat_writer /usr/local/lib/python3.12/site-packages/dbcounter.py:115}}
Jan 26 19:40:01.823818 np0005596550.novalocal devstack@n-api-meta.service[181171]: DEBUG dbcounter [-] [181171] Writing DB stats nova_cell1:SELECT=4 {{(pid=181171) stat_writer /usr/local/lib/python3.12/site-packages/dbcounter.py:115}}
Jan 26 19:40:02.362044 np0005596550.novalocal devstack@n-api-meta.service[181170]: DEBUG dbcounter [-] [181170] Writing DB stats nova_api:SELECT=1 {{(pid=181170) stat_writer /usr/local/lib/python3.12/site-packages/dbcounter.py:115}}
Jan 26 19:40:02.417886 np0005596550.novalocal devstack@n-api-meta.service[181170]: DEBUG dbcounter [-] [181170] Writing DB stats nova_cell1:SELECT=6,nova_cell1:UPDATE=1,nova_cell1:INSERT=1 {{(pid=181170) stat_writer /usr/local/lib/python3.12/site-packages/dbcounter.py:115}}