Attachment 15575 Details for Bug 49448 – neutron-server.log

neutron-server.log

neutron-server.log (text/plain), 15.02 KB, created by Nikolai Zurabishvili on 2024-02-19 10:39:39 MSK

(hide)

Description:

Filename:

MIME Type:

Creator: Nikolai Zurabishvili

Created: 2024-02-19 10:39:39 MSK

Size: 15.02 KB

patch

obsolete

>2024-02-13 17:32:07.777 203724 INFO neutron.wsgi [None req-21ea09ec-f3bf-4b35-8c56-f51d6c12092e 86bedfb9f89142f9967b8a72bbd8a387 fc8af937402648e5b623db117fb21f75 - - default default] 10.88.12.39 "GET /v2.0/subnets?name=test-subnet&fields=id HTTP/1.1" status: 200  len: 257 time: 0.0368395
>2024-02-13 17:32:07.933 203724 WARNING neutron.scheduler.dhcp_agent_scheduler [None req-c0e57cd0-5b98-4061-a024-53cee8f89788 86bedfb9f89142f9967b8a72bbd8a387 fc8af937402648e5b623db117fb21f75 - - default default] No more DHCP agents
>2024-02-13 17:32:07.935 203724 WARNING neutron.api.rpc.agentnotifiers.dhcp_rpc_agent_api [None req-c0e57cd0-5b98-4061-a024-53cee8f89788 86bedfb9f89142f9967b8a72bbd8a387 fc8af937402648e5b623db117fb21f75 - - default default] Unable to schedule network 7a04fda6-fe27-40fc-b07d-5d3096317e8a: no agents available; will retry on subsequent port and subnet creation events.
>2024-02-13 17:32:07.957 203724 INFO neutron_lbaas.services.loadbalancer.plugin [None req-c0e57cd0-5b98-4061-a024-53cee8f89788 86bedfb9f89142f9967b8a72bbd8a387 fc8af937402648e5b623db117fb21f75 - - default default] Calling driver operation LoadBalancerManager.create
>2024-02-13 17:32:07.960 203724 WARNING neutron_lbaas.agent_scheduler [None req-c0e57cd0-5b98-4061-a024-53cee8f89788 86bedfb9f89142f9967b8a72bbd8a387 fc8af937402648e5b623db117fb21f75 - - default default] No active lbaas agents for load balancer c811d3bf-e929-4aa8-a843-5d53bc8c0da7
>2024-02-13 17:32:07.962 203724 ERROR root [None req-c0e57cd0-5b98-4061-a024-53cee8f89788 86bedfb9f89142f9967b8a72bbd8a387 fc8af937402648e5b623db117fb21f75 - - default default] Original exception being dropped: ['Traceback (most recent call last):\n', '  File "/usr/lib/python3/site-packages/neutron_lbaas/services/loadbalancer/plugin.py", line 393, in create_loadbalancer\n    self._call_driver_operation(context, create_method, lb_db)\n', '  File "/usr/lib/python3/site-packages/neutron_lbaas/services/loadbalancer/plugin.py", line 185, in _call_driver_operation\n    raise no_agent\n', '  File "/usr/lib/python3/site-packages/neutron_lbaas/services/loadbalancer/plugin.py", line 181, in _call_driver_operation\n    driver_method(context, db_entity, **kwargs)\n', '  File "/usr/lib/python3/site-packages/neutron_lbaas/drivers/common/agent_driver_base.py", line 217, in create\n    raise lbaas_agentschedulerv2.NoEligibleLbaasAgent(\n', 'neutron_lbaas.extensions.lbaas_agentschedulerv2.NoEligibleLbaasAgent: No eligible agent found for loadbalancer c811d3bf-e929-4aa8-a843-5d53bc8c0da7.\n', '\nDuring handling of the above exception, another exception occurred:\n\n', 'Traceback (most recent call last):\n', '  File "/usr/lib/python3/site-packages/neutron_lbaas/db/loadbalancer/loadbalancer_dbv2.py", line 76, in _get_resource\n    resource = model_query.get_by_id(context, model, id)\n', '  File "/usr/lib/python3/site-packages/neutron_lib/db/model_query.py", line 178, in get_by_id\n    return query.filter(model.id == object_id).one()\n', '  File "/usr/lib64/python3/site-packages/sqlalchemy/orm/query.py", line 2869, in one\n    return self._iter().one()\n', '  File "/usr/lib64/python3/site-packages/sqlalchemy/engine/result.py", line 1476, in one\n    return self._only_one_row(\n', '  File "/usr/lib64/python3/site-packages/sqlalchemy/engine/result.py", line 562, in _only_one_row\n    raise exc.NoResultFound(\n', 'sqlalchemy.exc.NoResultFound: No row was found when one was required\n', '\nDuring handling of the above exception, another exception occurred:\n\n', 'Traceback (most recent call last):\n', '  File "/usr/lib/python3/site-packages/neutron/api/v2/base.py", line 537, in do_create\n    return obj_creator(request.context, **kwargs)\n', '  File "/usr/lib/python3/site-packages/neutron_lbaas/services/loadbalancer/plugin.py", line 396, in create_loadbalancer\n    self.db.delete_loadbalancer(context, lb_db.id)\n', '  File "/usr/lib/python3/site-packages/neutron_lbaas/db/loadbalancer/loadbalancer_dbv2.py", line 370, in delete_loadbalancer\n    lb_db = self._get_resource(context, models.LoadBalancer, id)\n', '  File "/usr/lib/python3/site-packages/neutron_lbaas/db/loadbalancer/loadbalancer_dbv2.py", line 85, in _get_resource\n    raise loadbalancerv2.EntityNotFound(name=model.NAME, id=id)\n', 'neutron_lbaas.extensions.loadbalancerv2.EntityNotFound: loadbalancer c811d3bf-e929-4aa8-a843-5d53bc8c0da7 could not be found\n']: RuntimeError: Method <function remove_reservation at 0x7f0320073af0> cannot be called within a transaction.
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource [None req-c0e57cd0-5b98-4061-a024-53cee8f89788 86bedfb9f89142f9967b8a72bbd8a387 fc8af937402648e5b623db117fb21f75 - - default default] create failed: No details.: RuntimeError: Method <function remove_reservation at 0x7f0320073af0> cannot be called within a transaction.
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource Traceback (most recent call last):
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lbaas/services/loadbalancer/plugin.py", line 393, in create_loadbalancer
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     self._call_driver_operation(context, create_method, lb_db)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lbaas/services/loadbalancer/plugin.py", line 185, in _call_driver_operation
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     raise no_agent
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lbaas/services/loadbalancer/plugin.py", line 181, in _call_driver_operation
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     driver_method(context, db_entity, **kwargs)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lbaas/drivers/common/agent_driver_base.py", line 217, in create
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     raise lbaas_agentschedulerv2.NoEligibleLbaasAgent(
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource neutron_lbaas.extensions.lbaas_agentschedulerv2.NoEligibleLbaasAgent: No eligible agent found for loadbalancer c811d3bf-e929-4aa8-a843-5d53bc8c0da7.
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource 
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource During handling of the above exception, another exception occurred:
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource 
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource Traceback (most recent call last):
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lbaas/db/loadbalancer/loadbalancer_dbv2.py", line 76, in _get_resource
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     resource = model_query.get_by_id(context, model, id)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lib/db/model_query.py", line 178, in get_by_id
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     return query.filter(model.id == object_id).one()
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib64/python3/site-packages/sqlalchemy/orm/query.py", line 2869, in one
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     return self._iter().one()
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib64/python3/site-packages/sqlalchemy/engine/result.py", line 1476, in one
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     return self._only_one_row(
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib64/python3/site-packages/sqlalchemy/engine/result.py", line 562, in _only_one_row
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     raise exc.NoResultFound(
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource sqlalchemy.exc.NoResultFound: No row was found when one was required
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource 
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource During handling of the above exception, another exception occurred:
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource 
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource Traceback (most recent call last):
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron/api/v2/base.py", line 537, in do_create
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     return obj_creator(request.context, **kwargs)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lbaas/services/loadbalancer/plugin.py", line 396, in create_loadbalancer
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     self.db.delete_loadbalancer(context, lb_db.id)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lbaas/db/loadbalancer/loadbalancer_dbv2.py", line 370, in delete_loadbalancer
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     lb_db = self._get_resource(context, models.LoadBalancer, id)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lbaas/db/loadbalancer/loadbalancer_dbv2.py", line 85, in _get_resource
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     raise loadbalancerv2.EntityNotFound(name=model.NAME, id=id)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource neutron_lbaas.extensions.loadbalancerv2.EntityNotFound: loadbalancer c811d3bf-e929-4aa8-a843-5d53bc8c0da7 could not be found
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource 
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource During handling of the above exception, another exception occurred:
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource 
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource Traceback (most recent call last):
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron/api/v2/resource.py", line 98, in resource
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     result = method(request=request, **args)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron/api/v2/base.py", line 438, in create
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     return self._create(request, body, **kwargs)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lib/db/api.py", line 142, in wrapped
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     setattr(e, '_RETRY_EXCEEDED', True)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/oslo_utils/excutils.py", line 227, in __exit__
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     self.force_reraise()
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/oslo_utils/excutils.py", line 200, in force_reraise
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     raise self.value
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lib/db/api.py", line 138, in wrapped
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     return f(*args, **kwargs)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/oslo_db/api.py", line 154, in wrapper
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     ectxt.value = e.inner_exc
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/oslo_utils/excutils.py", line 227, in __exit__
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     self.force_reraise()
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/oslo_utils/excutils.py", line 200, in force_reraise
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     raise self.value
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/oslo_db/api.py", line 142, in wrapper
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     return f(*args, **kwargs)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lib/db/api.py", line 190, in wrapped
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     context_reference.session.rollback()
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/oslo_utils/excutils.py", line 227, in __exit__
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     self.force_reraise()
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/oslo_utils/excutils.py", line 200, in force_reraise
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     raise self.value
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron_lib/db/api.py", line 184, in wrapped
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     return f(*dup_args, **dup_kwargs)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron/api/v2/base.py", line 563, in _create
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     obj = do_create(body)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron/api/v2/base.py", line 543, in do_create
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     quota.QUOTAS.cancel_reservation(
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron/quota/__init__.py", line 106, in cancel_reservation
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     self.get_driver().cancel_reservation(context, reservation_id)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron/db/quota/driver_nolock.py", line 85, in cancel_reservation
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     quota_api.remove_reservation(context, reservation_id, set_dirty=False)
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource   File "/usr/lib/python3/site-packages/neutron/common/utils.py", line 729, in inner
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource     raise RuntimeError(_("Method %s cannot be called within a "
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource RuntimeError: Method <function remove_reservation at 0x7f0320073af0> cannot be called within a transaction.
>2024-02-13 17:32:07.962 203724 ERROR neutron.api.v2.resource 
>2024-02-13 17:32:07.964 203724 INFO neutron.wsgi [None req-c0e57cd0-5b98-4061-a024-53cee8f89788 86bedfb9f89142f9967b8a72bbd8a387 fc8af937402648e5b623db117fb21f75 - - default default] 10.88.12.39 "POST /v2.0/lbaas/loadbalancers HTTP/1.1" status: 500  len: 368 time: 0.1839240

Actions: View

Attachments on bug 49448: 15574 | 15575