2026-04-30 03:39:37,073 - INFO - Domain Default found not creating
2026-04-30 03:39:37,275 - INFO - Project ctest-TestSvcHC-26467608 not found, creating it
2026-04-30 03:39:37,814 - INFO - Created Project:ctest-TestSvcHC-26467608, ID : 51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:39,295 - INFO - ================================================================================
2026-04-30 03:39:39,295 - INFO - STARTING TEST : test_svc_hc_basic
2026-04-30 03:39:40,590 - DEBUG - Nothing to compare xmpp stats {'10.0.0.19': {'10.20.0.193': '0', '10.20.0.18': '0'}, '10.0.0.241': {'10.20.0.193': '0', '10.20.0.18': '0'}} with
2026-04-30 03:39:40,590 - INFO - Initial checks done. Running the testcase now
2026-04-30 03:39:40,590 - INFO -
2026-04-30 03:39:41,225 - DEBUG - Response for create_network : {'network': {'id': '649cddbd-6b35-4cd4-9303-aca935acdb28', 'name': 'ctest-mgmt_vn-72423045', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'project_id': '5167700159f74ab6870ae052f8a81c81', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcHC-26467608', 'ctest-mgmt_vn-72423045'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:41,520 - DEBUG - Response for create_subnet : {'subnet': {'id': 'ad915a93-e22c-49ee-bb77-50827cbcd2f2', 'name': '', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'network_id': '649cddbd-6b35-4cd4-9303-aca935acdb28', 'ip_version': 4, 'cidr': '70.73.1.128/26', 'allocation_pools': [{'start': '70.73.1.130', 'end': '70.73.1.190'}], 'gateway_ip': '70.73.1.129', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '70.73.1.130', 'tags': [], 'project_id': '5167700159f74ab6870ae052f8a81c81'}}
2026-04-30 03:39:41,543 - INFO - Created VN ctest-mgmt_vn-72423045
2026-04-30 03:39:41,555 - DEBUG - VN ctest-mgmt_vn-72423045 UUID is 649cddbd-6b35-4cd4-9303-aca935acdb28
2026-04-30 03:39:41,630 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:41,927 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:41,958 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:41,973 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:42,070 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/649cddbd-6b35-4cd4-9303-aca935acdb28
2026-04-30 03:39:42,084 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/649cddbd-6b35-4cd4-9303-aca935acdb28
2026-04-30 03:39:42,094 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f3c5e3e5-cb33-4556-82ee-06bd14c27d31
2026-04-30 03:39:42,103 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f3c5e3e5-cb33-4556-82ee-06bd14c27d31
2026-04-30 03:39:42,111 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/fa052611-b98e-4de2-8f34-aa2004f0a537
2026-04-30 03:39:42,119 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:42,119 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/649cddbd-6b35-4cd4-9303-aca935acdb28
2026-04-30 03:39:42,128 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f3c5e3e5-cb33-4556-82ee-06bd14c27d31
2026-04-30 03:39:42,143 - INFO - Verified VN network id 17 for VN 649cddbd-6b35-4cd4-9303-aca935acdb28
2026-04-30 03:39:42,144 - INFO - Verifications in API Server for VN ctest-mgmt_vn-72423045 passed
2026-04-30 03:39:42,144 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/649cddbd-6b35-4cd4-9303-aca935acdb28
2026-04-30 03:39:42,153 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f3c5e3e5-cb33-4556-82ee-06bd14c27d31
2026-04-30 03:39:42,161 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f3c5e3e5-cb33-4556-82ee-06bd14c27d31
2026-04-30 03:39:42,169 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/fa052611-b98e-4de2-8f34-aa2004f0a537
2026-04-30 03:39:42,180 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '7249913305776868564', 'uuid-lslong': '10593500591255509800'}, 'enable': 'true', 'created': '2026-04-30T03:39:41', 'last-modified': '2026-04-30T03:39:41', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.718761'}
2026-04-30 03:39:42,185 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:42,192 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '7249913305776868564', 'uuid-lslong': '10593500591255509800'}, 'enable': 'true', 'created': '2026-04-30T03:39:41', 'last-modified': '2026-04-30T03:39:41', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.730305'}
2026-04-30 03:39:42,199 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:42,204 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '7249913305776868564', 'uuid-lslong': '10593500591255509800'}, 'enable': 'true', 'created': '2026-04-30T03:39:41', 'last-modified': '2026-04-30T03:39:41', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.739862'}
2026-04-30 03:39:42,211 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:42,211 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-mgmt_vn-72423045 passed
2026-04-30 03:39:42,211 - DEBUG - ====Verifying policy data for ctest-mgmt_vn-72423045 in API_Server ======
2026-04-30 03:39:42,211 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:42,218 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:42,229 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:42,320 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/649cddbd-6b35-4cd4-9303-aca935acdb28
2026-04-30 03:39:42,332 - DEBUG - =>VN ctest-mgmt_vn-72423045 has no policy to be verified
2026-04-30 03:39:42,333 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:42,333 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:42,333 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:42,627 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:42,691 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045?flat'}
2026-04-30 03:39:42,691 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:42,691 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:42,985 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:43,046 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045?flat'}
2026-04-30 03:39:43,046 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:43,046 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:43,339 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:43,401 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045?flat'}
2026-04-30 03:39:43,401 - INFO - Validated that VN default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-72423045 is found in opserver
2026-04-30 03:39:43,421 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:39:43,430 - DEBUG - VRF ids for VN ctest-mgmt_vn-72423045: {}
2026-04-30 03:39:43,714 - DEBUG - Response for create_network : {'network': {'id': '9127a6d5-f9cb-4448-bd18-f911f02b7e72', 'name': 'ctest-left_vn-21775581', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'project_id': '5167700159f74ab6870ae052f8a81c81', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcHC-26467608', 'ctest-left_vn-21775581'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:43,938 - DEBUG - Response for create_subnet : {'subnet': {'id': '151b837f-9347-4c81-96f8-b71e0e718fef', 'name': '', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'network_id': '9127a6d5-f9cb-4448-bd18-f911f02b7e72', 'ip_version': 4, 'cidr': '11.13.221.0/26', 'allocation_pools': [{'start': '11.13.221.2', 'end': '11.13.221.62'}], 'gateway_ip': '11.13.221.1', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '11.13.221.2', 'tags': [], 'project_id': '5167700159f74ab6870ae052f8a81c81'}}
2026-04-30 03:39:43,960 - INFO - Created VN ctest-left_vn-21775581
2026-04-30 03:39:43,972 - DEBUG - VN ctest-left_vn-21775581 UUID is 9127a6d5-f9cb-4448-bd18-f911f02b7e72
2026-04-30 03:39:44,044 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:44,050 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:44,061 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:44,160 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/9127a6d5-f9cb-4448-bd18-f911f02b7e72
2026-04-30 03:39:44,172 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/9127a6d5-f9cb-4448-bd18-f911f02b7e72
2026-04-30 03:39:44,182 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/6738879b-e761-4daa-88c1-d9e18dbac98a
2026-04-30 03:39:44,191 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/6738879b-e761-4daa-88c1-d9e18dbac98a
2026-04-30 03:39:44,198 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/381cc73f-2757-4455-860c-aaa1642b3c2b
2026-04-30 03:39:44,207 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:44,207 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/9127a6d5-f9cb-4448-bd18-f911f02b7e72
2026-04-30 03:39:44,216 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/6738879b-e761-4daa-88c1-d9e18dbac98a
2026-04-30 03:39:44,231 - INFO - Verified VN network id 18 for VN 9127a6d5-f9cb-4448-bd18-f911f02b7e72
2026-04-30 03:39:44,231 - INFO - Verifications in API Server for VN ctest-left_vn-21775581 passed
2026-04-30 03:39:44,231 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/9127a6d5-f9cb-4448-bd18-f911f02b7e72
2026-04-30 03:39:44,240 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/6738879b-e761-4daa-88c1-d9e18dbac98a
2026-04-30 03:39:44,247 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/6738879b-e761-4daa-88c1-d9e18dbac98a
2026-04-30 03:39:44,255 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/381cc73f-2757-4455-860c-aaa1642b3c2b
2026-04-30 03:39:44,267 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '10459512097540359240', 'uuid-lslong': '13625914528048578162'}, 'enable': 'true', 'created': '2026-04-30T03:39:43', 'last-modified': '2026-04-30T03:39:43', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.378948'}
2026-04-30 03:39:44,271 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:44,277 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '10459512097540359240', 'uuid-lslong': '13625914528048578162'}, 'enable': 'true', 'created': '2026-04-30T03:39:43', 'last-modified': '2026-04-30T03:39:43', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.395207'}
2026-04-30 03:39:44,284 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:44,290 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '10459512097540359240', 'uuid-lslong': '13625914528048578162'}, 'enable': 'true', 'created': '2026-04-30T03:39:43', 'last-modified': '2026-04-30T03:39:43', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.416392'}
2026-04-30 03:39:44,296 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:44,296 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-left_vn-21775581 passed
2026-04-30 03:39:44,296 - DEBUG - ====Verifying policy data for ctest-left_vn-21775581 in API_Server ======
2026-04-30 03:39:44,297 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:44,302 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:44,314 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:44,400 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/9127a6d5-f9cb-4448-bd18-f911f02b7e72
2026-04-30 03:39:44,411 - DEBUG - =>VN ctest-left_vn-21775581 has no policy to be verified
2026-04-30 03:39:44,411 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:44,411 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:44,411 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:44,474 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581?flat'}
2026-04-30 03:39:44,474 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:44,475 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:44,533 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581?flat'}
2026-04-30 03:39:44,534 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:44,534 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:44,593 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581?flat'}
2026-04-30 03:39:44,593 - INFO - Validated that VN default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-21775581 is found in opserver
2026-04-30 03:39:44,623 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:39:44,637 - DEBUG - VRF ids for VN ctest-left_vn-21775581: {}
2026-04-30 03:39:44,915 - DEBUG - Response for create_network : {'network': {'id': '441d9a7d-e0fd-4396-8dc4-b598a110f87c', 'name': 'ctest-right_vn-25218984', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'project_id': '5167700159f74ab6870ae052f8a81c81', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcHC-26467608', 'ctest-right_vn-25218984'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:45,136 - DEBUG - Response for create_subnet : {'subnet': {'id': '31c991d1-06ca-48d6-8942-f5138c8d4baf', 'name': '', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'network_id': '441d9a7d-e0fd-4396-8dc4-b598a110f87c', 'ip_version': 4, 'cidr': '217.130.115.192/26', 'allocation_pools': [{'start': '217.130.115.194', 'end': '217.130.115.254'}], 'gateway_ip': '217.130.115.193', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '217.130.115.194', 'tags': [], 'project_id': '5167700159f74ab6870ae052f8a81c81'}}
2026-04-30 03:39:45,162 - INFO - Created VN ctest-right_vn-25218984
2026-04-30 03:39:45,177 - DEBUG - VN ctest-right_vn-25218984 UUID is 441d9a7d-e0fd-4396-8dc4-b598a110f87c
2026-04-30 03:39:45,250 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:45,256 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:45,268 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:45,369 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/441d9a7d-e0fd-4396-8dc4-b598a110f87c
2026-04-30 03:39:45,381 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/441d9a7d-e0fd-4396-8dc4-b598a110f87c
2026-04-30 03:39:45,392 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/be09d7ae-3881-4e9e-8e67-eca1da52f052
2026-04-30 03:39:45,400 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/be09d7ae-3881-4e9e-8e67-eca1da52f052
2026-04-30 03:39:45,407 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/75b51181-0a8b-4811-a6ec-e3ed7024c7c9
2026-04-30 03:39:45,416 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:45,416 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/441d9a7d-e0fd-4396-8dc4-b598a110f87c
2026-04-30 03:39:45,426 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/be09d7ae-3881-4e9e-8e67-eca1da52f052
2026-04-30 03:39:45,443 - INFO - Verified VN network id 19 for VN 441d9a7d-e0fd-4396-8dc4-b598a110f87c
2026-04-30 03:39:45,445 - INFO - Verifications in API Server for VN ctest-right_vn-25218984 passed
2026-04-30 03:39:45,445 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/441d9a7d-e0fd-4396-8dc4-b598a110f87c
2026-04-30 03:39:45,459 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/be09d7ae-3881-4e9e-8e67-eca1da52f052
2026-04-30 03:39:45,467 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/be09d7ae-3881-4e9e-8e67-eca1da52f052
2026-04-30 03:39:45,474 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/75b51181-0a8b-4811-a6ec-e3ed7024c7c9
2026-04-30 03:39:45,489 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '4908249034339992470', 'uuid-lslong': '10215489521925027964'}, 'enable': 'true', 'created': '2026-04-30T03:39:44', 'last-modified': '2026-04-30T03:39:45', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.408210'}
2026-04-30 03:39:45,497 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:45,502 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '4908249034339992470', 'uuid-lslong': '10215489521925027964'}, 'enable': 'true', 'created': '2026-04-30T03:39:44', 'last-modified': '2026-04-30T03:39:45', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.425998'}
2026-04-30 03:39:45,510 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:45,515 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '4908249034339992470', 'uuid-lslong': '10215489521925027964'}, 'enable': 'true', 'created': '2026-04-30T03:39:44', 'last-modified': '2026-04-30T03:39:45', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.434214'}
2026-04-30 03:39:45,521 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:45,521 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-right_vn-25218984 passed
2026-04-30 03:39:45,521 - DEBUG - ====Verifying policy data for ctest-right_vn-25218984 in API_Server ======
2026-04-30 03:39:45,521 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:45,527 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:45,539 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:45,641 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/441d9a7d-e0fd-4396-8dc4-b598a110f87c
2026-04-30 03:39:45,650 - DEBUG - =>VN ctest-right_vn-25218984 has no policy to be verified
2026-04-30 03:39:45,651 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:45,651 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:45,651 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:45,740 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984?flat'}
2026-04-30 03:39:45,740 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:45,740 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:45,804 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984?flat'}
2026-04-30 03:39:45,804 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:45,804 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:45,871 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984?flat'}
2026-04-30 03:39:45,871 - INFO - Validated that VN default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-25218984 is found in opserver
2026-04-30 03:39:45,906 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:39:45,916 - DEBUG - VRF ids for VN ctest-right_vn-25218984: {}
2026-04-30 03:39:46,075 - DEBUG - Services list from nova: [, , , ]
2026-04-30 03:39:47,197 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-5725-2), Zone: (nova:an-jenkins-deploy-platform-ansible-os-5725-2)
2026-04-30 03:39:48,687 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-5725-1), Zone: (nova:an-jenkins-deploy-platform-ansible-os-5725-1)
2026-04-30 03:39:48,687 - DEBUG - Creating service template: ['default-domain', 'ctest-service_template_1-35404633']
2026-04-30 03:39:48,997 - DEBUG - Service template: ['default-domain', 'ctest-service_template_1-35404633'] created succesfully
2026-04-30 03:39:49,445 - DEBUG - Image by name tiny_nat_fw not found
2026-04-30 03:39:49,445 - DEBUG - Installing image tiny_nat_fw
2026-04-30 03:39:49,445 - DEBUG - Image info {'name': 'tinycore-in-network-nat.qcow2.gz', 'webserver': '', 'location': '/images/tinycore/', 'username': 'tc', 'password': 'secret', 'type': 'os', 'flavor': 'contrail_flavor_tiny', 'params': '--container-format bare --disk-format vmdk --property vmware_disktype="sparse" --property vmware_adaptertype="ide" --property hypervisor_type=qemu', 'name_docker': 'phusion-baseimage-enablesshd', 'vmdk': 'service_chain_images/nat_service/tiny_nat_fw/tinycore-in-network-nat-flat.vmdk', 'shrinked_vmdk': "'no'"}
2026-04-30 03:39:49,445 - DEBUG - Image build path file:///contrail-test/images/tinycore-in-network-nat.qcow2.gz
2026-04-30 03:39:49,446 - DEBUG - Download image from local file file:///contrail-test/images/tinycore-in-network-nat.qcow2.gz
2026-04-30 03:39:49,446 - DEBUG - Unzip image
2026-04-30 03:39:49,446 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: gunzip -f /contrail-test/images/tinycore-in-network-nat.qcow2.gz
2026-04-30 03:39:49,463 - INFO - image /contrail-test/images/tinycore-in-network-nat.qcow2 is not found
2026-04-30 03:39:49,464 - DEBUG - Deleting service template: ['default-domain', 'ctest-service_template_1-35404633']
2026-04-30 03:39:49,578 - INFO - Service template: ['default-domain', 'ctest-service_template_1-35404633'] deleted successfully.
2026-04-30 03:39:49,578 - INFO - Skip interface_detach for VM ctest-right_vm-47104672 in state BUILD
2026-04-30 03:39:49,578 - INFO - Deleting VM ctest-right_vm-47104672
2026-04-30 03:39:49,639 - ERROR - VM ctest-right_vm-47104672 has failed to come up
2026-04-30 03:39:49,639 - ERROR - Nova failed to get host of the VM
2026-04-30 03:39:49,639 - ERROR - VM ctest-right_vm-47104672 has failed to come up
2026-04-30 03:39:49,639 - ERROR - Nova failed to get host of the VM
2026-04-30 03:39:49,709 - INFO - Skip interface_detach for VM ctest-left_vm-81656211 in state BUILD
2026-04-30 03:39:49,709 - INFO - Deleting VM ctest-left_vm-81656211
2026-04-30 03:39:49,709 - ERROR - VM ctest-left_vm-81656211 has failed to come up
2026-04-30 03:39:49,709 - ERROR - Nova failed to get host of the VM
2026-04-30 03:39:49,709 - ERROR - VM ctest-left_vm-81656211 has failed to come up
2026-04-30 03:39:49,709 - ERROR - Nova failed to get host of the VM
2026-04-30 03:39:49,777 - INFO - Deleting VN ctest-right_vn-25218984
2026-04-30 03:39:49,820 - DEBUG - VN 441d9a7d-e0fd-4396-8dc4-b598a110f87c still in use: Unable to complete operation on network 441d9a7d-e0fd-4396-8dc4-b598a110f87c. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-ec5991cc-0746-4cf8-b8bc-c06d99007ec9']
2026-04-30 03:39:49,820 - WARNING - Deleting VN ctest-right_vn-25218984 failed..Will retry
2026-04-30 03:39:52,011 - DEBUG - Response for deleting network ()
2026-04-30 03:39:52,011 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/be09d7ae-3881-4e9e-8e67-eca1da52f052
2026-04-30 03:39:52,018 - DEBUG - Response Code: 404
2026-04-30 03:39:52,019 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:52,028 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:52,067 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:52,188 - INFO - Validated that VN ctest-right_vn-25218984 is not found in API Server
2026-04-30 03:39:52,201 - DEBUG - VN ctest-right_vn-25218984 is not present in Agent 10.0.0.19
2026-04-30 03:39:52,212 - DEBUG - VN ctest-right_vn-25218984 is not present in Agent 10.0.0.241
2026-04-30 03:39:52,212 - INFO - Validated that VN ctest-right_vn-25218984 is not in any agent
2026-04-30 03:39:52,263 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-right_vn-25218984 info
2026-04-30 03:39:52,263 - INFO - Deleting VN ctest-left_vn-21775581
2026-04-30 03:39:52,439 - DEBUG - Response for deleting network ()
2026-04-30 03:39:52,439 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/6738879b-e761-4daa-88c1-d9e18dbac98a
2026-04-30 03:39:52,446 - DEBUG - Response Code: 404
2026-04-30 03:39:52,446 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:52,454 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:52,488 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:52,599 - INFO - Validated that VN ctest-left_vn-21775581 is not found in API Server
2026-04-30 03:39:52,611 - DEBUG - VN ctest-left_vn-21775581 is not present in Agent 10.0.0.19
2026-04-30 03:39:52,621 - DEBUG - VN ctest-left_vn-21775581 is not present in Agent 10.0.0.241
2026-04-30 03:39:52,621 - INFO - Validated that VN ctest-left_vn-21775581 is not in any agent
2026-04-30 03:39:52,651 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-left_vn-21775581 info
2026-04-30 03:39:52,652 - INFO - Deleting VN ctest-mgmt_vn-72423045
2026-04-30 03:39:52,834 - DEBUG - Response for deleting network ()
2026-04-30 03:39:52,834 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f3c5e3e5-cb33-4556-82ee-06bd14c27d31
2026-04-30 03:39:52,840 - DEBUG - Response Code: 404
2026-04-30 03:39:52,840 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:52,850 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:52,861 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:52,946 - INFO - Validated that VN ctest-mgmt_vn-72423045 is not found in API Server
2026-04-30 03:39:52,958 - DEBUG - VN ctest-mgmt_vn-72423045 is not present in Agent 10.0.0.19
2026-04-30 03:39:52,970 - DEBUG - VN ctest-mgmt_vn-72423045 is not present in Agent 10.0.0.241
2026-04-30 03:39:52,970 - INFO - Validated that VN ctest-mgmt_vn-72423045 is not in any agent
2026-04-30 03:39:53,006 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-mgmt_vn-72423045 info
2026-04-30 03:39:54,330 - DEBUG - No XMPP flaps were noticed during the test
2026-04-30 03:39:54,330 - INFO -
2026-04-30 03:39:54,330 - INFO - END TEST : test_svc_hc_basic : SKIPPED[0:00:15]
2026-04-30 03:39:54,330 - INFO - --------------------------------------------------------------------------------
2026-04-30 03:39:54,333 - INFO - ================================================================================
2026-04-30 03:39:54,333 - INFO - STARTING TEST : test_svc_trans_segment_right_hc_fail_svm
2026-04-30 03:39:55,641 - DEBUG - Nothing to compare xmpp stats {'10.0.0.19': {'10.20.0.193': '0', '10.20.0.18': '0'}, '10.0.0.241': {'10.20.0.193': '0', '10.20.0.18': '0'}} with
2026-04-30 03:39:55,641 - INFO - Initial checks done. Running the testcase now
2026-04-30 03:39:55,641 - INFO -
2026-04-30 03:39:55,911 - DEBUG - Response for create_network : {'network': {'id': 'f215316c-b76d-4cc4-9d4c-5edb73461ec8', 'name': 'ctest-mgmt_vn-33640056', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'project_id': '5167700159f74ab6870ae052f8a81c81', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcHC-26467608', 'ctest-mgmt_vn-33640056'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:56,183 - DEBUG - Response for create_subnet : {'subnet': {'id': '66f07a9e-6ae7-4a26-a4f7-c28ec24f2277', 'name': '', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'network_id': 'f215316c-b76d-4cc4-9d4c-5edb73461ec8', 'ip_version': 4, 'cidr': '133.198.33.64/26', 'allocation_pools': [{'start': '133.198.33.66', 'end': '133.198.33.126'}], 'gateway_ip': '133.198.33.65', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '133.198.33.66', 'tags': [], 'project_id': '5167700159f74ab6870ae052f8a81c81'}}
2026-04-30 03:39:56,205 - INFO - Created VN ctest-mgmt_vn-33640056
2026-04-30 03:39:56,219 - DEBUG - VN ctest-mgmt_vn-33640056 UUID is f215316c-b76d-4cc4-9d4c-5edb73461ec8
2026-04-30 03:39:56,296 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:56,301 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:56,311 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:56,413 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/f215316c-b76d-4cc4-9d4c-5edb73461ec8
2026-04-30 03:39:56,423 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/f215316c-b76d-4cc4-9d4c-5edb73461ec8
2026-04-30 03:39:56,432 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/ff075641-f033-4c9b-b43a-a432f4298c0c
2026-04-30 03:39:56,439 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/ff075641-f033-4c9b-b43a-a432f4298c0c
2026-04-30 03:39:56,445 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/2a9326a0-3453-4911-bba2-4d0e968b1a34
2026-04-30 03:39:56,452 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:56,452 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/f215316c-b76d-4cc4-9d4c-5edb73461ec8
2026-04-30 03:39:56,460 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/ff075641-f033-4c9b-b43a-a432f4298c0c
2026-04-30 03:39:56,474 - INFO - Verified VN network id 17 for VN f215316c-b76d-4cc4-9d4c-5edb73461ec8
2026-04-30 03:39:56,474 - INFO - Verifications in API Server for VN ctest-mgmt_vn-33640056 passed
2026-04-30 03:39:56,474 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/f215316c-b76d-4cc4-9d4c-5edb73461ec8
2026-04-30 03:39:56,483 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/ff075641-f033-4c9b-b43a-a432f4298c0c
2026-04-30 03:39:56,489 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/ff075641-f033-4c9b-b43a-a432f4298c0c
2026-04-30 03:39:56,497 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/2a9326a0-3453-4911-bba2-4d0e968b1a34
2026-04-30 03:39:56,508 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '17443903074693106884', 'uuid-lslong': '11334538658809519816'}, 'enable': 'true', 'created': '2026-04-30T03:39:55', 'last-modified': '2026-04-30T03:39:56', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.387315'}
2026-04-30 03:39:56,513 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:56,520 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '17443903074693106884', 'uuid-lslong': '11334538658809519816'}, 'enable': 'true', 'created': '2026-04-30T03:39:55', 'last-modified': '2026-04-30T03:39:56', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.393482'}
2026-04-30 03:39:56,528 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:56,534 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '17443903074693106884', 'uuid-lslong': '11334538658809519816'}, 'enable': 'true', 'created': '2026-04-30T03:39:55', 'last-modified': '2026-04-30T03:39:56', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.417809'}
2026-04-30 03:39:56,540 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:56,540 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-mgmt_vn-33640056 passed
2026-04-30 03:39:56,540 - DEBUG - ====Verifying policy data for ctest-mgmt_vn-33640056 in API_Server ======
2026-04-30 03:39:56,540 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:56,546 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:56,555 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:56,654 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/f215316c-b76d-4cc4-9d4c-5edb73461ec8
2026-04-30 03:39:56,663 - DEBUG - =>VN ctest-mgmt_vn-33640056 has no policy to be verified
2026-04-30 03:39:56,663 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:56,663 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:56,663 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:56,679 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056?flat'}
2026-04-30 03:39:56,679 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:56,679 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:56,695 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056?flat'}
2026-04-30 03:39:56,695 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:56,695 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:56,708 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056?flat'}
2026-04-30 03:39:56,708 - INFO - Validated that VN default-domain:ctest-TestSvcHC-26467608:ctest-mgmt_vn-33640056 is found in opserver
2026-04-30 03:39:56,740 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:39:56,756 - DEBUG - VRF ids for VN ctest-mgmt_vn-33640056: {}
2026-04-30 03:39:57,055 - DEBUG - Response for create_network : {'network': {'id': 'fdbd7c1c-9706-413c-a096-c29fc9f33c9a', 'name': 'ctest-left_vn-51831725', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'project_id': '5167700159f74ab6870ae052f8a81c81', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcHC-26467608', 'ctest-left_vn-51831725'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:57,268 - DEBUG - Response for create_subnet : {'subnet': {'id': 'd79963ca-c2cf-42de-8d49-aad0d352b757', 'name': '', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'network_id': 'fdbd7c1c-9706-413c-a096-c29fc9f33c9a', 'ip_version': 4, 'cidr': '113.189.223.64/26', 'allocation_pools': [{'start': '113.189.223.66', 'end': '113.189.223.126'}], 'gateway_ip': '113.189.223.65', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '113.189.223.66', 'tags': [], 'project_id': '5167700159f74ab6870ae052f8a81c81'}}
2026-04-30 03:39:57,290 - INFO - Created VN ctest-left_vn-51831725
2026-04-30 03:39:57,302 - DEBUG - VN ctest-left_vn-51831725 UUID is fdbd7c1c-9706-413c-a096-c29fc9f33c9a
2026-04-30 03:39:57,372 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:57,378 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:57,389 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:57,485 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/fdbd7c1c-9706-413c-a096-c29fc9f33c9a
2026-04-30 03:39:57,495 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/fdbd7c1c-9706-413c-a096-c29fc9f33c9a
2026-04-30 03:39:57,504 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/6d0098b4-f9a9-4433-8727-fb754ccec529
2026-04-30 03:39:57,512 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/6d0098b4-f9a9-4433-8727-fb754ccec529
2026-04-30 03:39:57,519 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/a7d2553b-ae11-447b-888f-a55a4f98ff58
2026-04-30 03:39:57,525 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:57,525 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/fdbd7c1c-9706-413c-a096-c29fc9f33c9a
2026-04-30 03:39:57,538 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/6d0098b4-f9a9-4433-8727-fb754ccec529
2026-04-30 03:39:57,554 - INFO - Verified VN network id 18 for VN fdbd7c1c-9706-413c-a096-c29fc9f33c9a
2026-04-30 03:39:57,554 - INFO - Verifications in API Server for VN ctest-left_vn-51831725 passed
2026-04-30 03:39:57,554 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/fdbd7c1c-9706-413c-a096-c29fc9f33c9a
2026-04-30 03:39:57,563 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/6d0098b4-f9a9-4433-8727-fb754ccec529
2026-04-30 03:39:57,570 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/6d0098b4-f9a9-4433-8727-fb754ccec529
2026-04-30 03:39:57,576 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/a7d2553b-ae11-447b-888f-a55a4f98ff58
2026-04-30 03:39:57,589 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '18283906524428779836', 'uuid-lslong': '11571650284118817946'}, 'enable': 'true', 'created': '2026-04-30T03:39:56', 'last-modified': '2026-04-30T03:39:57', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.384251'}
2026-04-30 03:39:57,594 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:57,599 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '18283906524428779836', 'uuid-lslong': '11571650284118817946'}, 'enable': 'true', 'created': '2026-04-30T03:39:56', 'last-modified': '2026-04-30T03:39:57', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.390875'}
2026-04-30 03:39:57,604 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:57,610 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '18283906524428779836', 'uuid-lslong': '11571650284118817946'}, 'enable': 'true', 'created': '2026-04-30T03:39:56', 'last-modified': '2026-04-30T03:39:57', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.408863'}
2026-04-30 03:39:57,616 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:57,616 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-left_vn-51831725 passed
2026-04-30 03:39:57,616 - DEBUG - ====Verifying policy data for ctest-left_vn-51831725 in API_Server ======
2026-04-30 03:39:57,616 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:57,622 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:57,633 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:57,724 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/fdbd7c1c-9706-413c-a096-c29fc9f33c9a
2026-04-30 03:39:57,734 - DEBUG - =>VN ctest-left_vn-51831725 has no policy to be verified
2026-04-30 03:39:57,735 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:57,735 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:57,735 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:57,749 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725?flat'}
2026-04-30 03:39:57,749 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:57,749 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:57,762 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725?flat'}
2026-04-30 03:39:57,762 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:57,762 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:57,775 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725?flat'}
2026-04-30 03:39:57,775 - INFO - Validated that VN default-domain:ctest-TestSvcHC-26467608:ctest-left_vn-51831725 is found in opserver
2026-04-30 03:39:57,798 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:39:57,810 - DEBUG - VRF ids for VN ctest-left_vn-51831725: {}
2026-04-30 03:39:58,097 - DEBUG - Response for create_network : {'network': {'id': 'a64f0db8-3b3e-46cd-8655-3639becdd928', 'name': 'ctest-right_vn-62912183', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'project_id': '5167700159f74ab6870ae052f8a81c81', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcHC-26467608', 'ctest-right_vn-62912183'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:58,328 - DEBUG - Response for create_subnet : {'subnet': {'id': 'b232123d-9140-4dee-83d6-94b6aaea2909', 'name': '', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'network_id': 'a64f0db8-3b3e-46cd-8655-3639becdd928', 'ip_version': 4, 'cidr': '90.115.136.192/26', 'allocation_pools': [{'start': '90.115.136.194', 'end': '90.115.136.254'}], 'gateway_ip': '90.115.136.193', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '90.115.136.194', 'tags': [], 'project_id': '5167700159f74ab6870ae052f8a81c81'}}
2026-04-30 03:39:58,354 - INFO - Created VN ctest-right_vn-62912183
2026-04-30 03:39:58,370 - DEBUG - VN ctest-right_vn-62912183 UUID is a64f0db8-3b3e-46cd-8655-3639becdd928
2026-04-30 03:39:58,447 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:58,453 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:58,464 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:58,560 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/a64f0db8-3b3e-46cd-8655-3639becdd928
2026-04-30 03:39:58,571 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/a64f0db8-3b3e-46cd-8655-3639becdd928
2026-04-30 03:39:58,580 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/3b16d6e4-c27a-42cc-b1e9-57ce4ee5a45f
2026-04-30 03:39:58,586 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/3b16d6e4-c27a-42cc-b1e9-57ce4ee5a45f
2026-04-30 03:39:58,593 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/2add5dbd-930c-47d0-90ad-f158c2feec9b
2026-04-30 03:39:58,600 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:58,600 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/a64f0db8-3b3e-46cd-8655-3639becdd928
2026-04-30 03:39:58,609 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/3b16d6e4-c27a-42cc-b1e9-57ce4ee5a45f
2026-04-30 03:39:58,624 - INFO - Verified VN network id 19 for VN a64f0db8-3b3e-46cd-8655-3639becdd928
2026-04-30 03:39:58,624 - INFO - Verifications in API Server for VN ctest-right_vn-62912183 passed
2026-04-30 03:39:58,624 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/a64f0db8-3b3e-46cd-8655-3639becdd928
2026-04-30 03:39:58,635 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/3b16d6e4-c27a-42cc-b1e9-57ce4ee5a45f
2026-04-30 03:39:58,641 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/3b16d6e4-c27a-42cc-b1e9-57ce4ee5a45f
2026-04-30 03:39:58,648 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/2add5dbd-930c-47d0-90ad-f158c2feec9b
2026-04-30 03:39:58,661 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '11983812218375259853', 'uuid-lslong': '9679702595744946472'}, 'enable': 'true', 'created': '2026-04-30T03:39:58', 'last-modified': '2026-04-30T03:39:58', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.384104'}
2026-04-30 03:39:58,666 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:58,673 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '11983812218375259853', 'uuid-lslong': '9679702595744946472'}, 'enable': 'true', 'created': '2026-04-30T03:39:58', 'last-modified': '2026-04-30T03:39:58', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.392186'}
2026-04-30 03:39:58,680 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:58,685 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '11983812218375259853', 'uuid-lslong': '9679702595744946472'}, 'enable': 'true', 'created': '2026-04-30T03:39:58', 'last-modified': '2026-04-30T03:39:58', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.409259'}
2026-04-30 03:39:58,690 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:58,691 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-right_vn-62912183 passed
2026-04-30 03:39:58,691 - DEBUG - ====Verifying policy data for ctest-right_vn-62912183 in API_Server ======
2026-04-30 03:39:58,691 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:58,698 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:58,709 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:58,802 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/a64f0db8-3b3e-46cd-8655-3639becdd928
2026-04-30 03:39:58,822 - DEBUG - =>VN ctest-right_vn-62912183 has no policy to be verified
2026-04-30 03:39:58,822 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:58,822 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:58,822 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:58,841 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183?flat'}
2026-04-30 03:39:58,841 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:58,841 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:58,856 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183?flat'}
2026-04-30 03:39:58,856 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:58,856 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:58,868 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183?flat'}
2026-04-30 03:39:58,868 - INFO - Validated that VN default-domain:ctest-TestSvcHC-26467608:ctest-right_vn-62912183 is found in opserver
2026-04-30 03:39:58,892 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:39:58,905 - DEBUG - VRF ids for VN ctest-right_vn-62912183: {}
2026-04-30 03:39:59,157 - DEBUG - Response for create_network : {'network': {'id': 'd8f6f7c4-818f-444a-916a-4a3a5642ef7e', 'name': 'ctest-trans_left_vn-13004312', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'project_id': '5167700159f74ab6870ae052f8a81c81', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcHC-26467608', 'ctest-trans_left_vn-13004312'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:59,441 - DEBUG - Response for create_subnet : {'subnet': {'id': 'ac26d8d5-76b1-4549-b524-1827b964fea0', 'name': '', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'network_id': 'd8f6f7c4-818f-444a-916a-4a3a5642ef7e', 'ip_version': 4, 'cidr': '212.94.79.192/26', 'allocation_pools': [{'start': '212.94.79.194', 'end': '212.94.79.254'}], 'gateway_ip': '212.94.79.193', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '212.94.79.194', 'tags': [], 'project_id': '5167700159f74ab6870ae052f8a81c81'}}
2026-04-30 03:39:59,464 - INFO - Created VN ctest-trans_left_vn-13004312
2026-04-30 03:39:59,475 - DEBUG - VN ctest-trans_left_vn-13004312 UUID is d8f6f7c4-818f-444a-916a-4a3a5642ef7e
2026-04-30 03:39:59,562 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:59,568 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:59,578 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:59,676 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/d8f6f7c4-818f-444a-916a-4a3a5642ef7e
2026-04-30 03:39:59,693 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/d8f6f7c4-818f-444a-916a-4a3a5642ef7e
2026-04-30 03:39:59,705 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/a0a5bef6-c521-4a98-be40-3258c33cc540
2026-04-30 03:39:59,713 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/a0a5bef6-c521-4a98-be40-3258c33cc540
2026-04-30 03:39:59,721 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/2715559a-e713-4423-bdf1-fc98c7f5ff85
2026-04-30 03:39:59,728 - DEBUG - Route Targets: ['target:64512:8000010']
2026-04-30 03:39:59,728 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/d8f6f7c4-818f-444a-916a-4a3a5642ef7e
2026-04-30 03:39:59,738 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/a0a5bef6-c521-4a98-be40-3258c33cc540
2026-04-30 03:39:59,753 - INFO - Verified VN network id 20 for VN d8f6f7c4-818f-444a-916a-4a3a5642ef7e
2026-04-30 03:39:59,753 - INFO - Verifications in API Server for VN ctest-trans_left_vn-13004312 passed
2026-04-30 03:39:59,753 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/d8f6f7c4-818f-444a-916a-4a3a5642ef7e
2026-04-30 03:39:59,763 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/a0a5bef6-c521-4a98-be40-3258c33cc540
2026-04-30 03:39:59,778 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/a0a5bef6-c521-4a98-be40-3258c33cc540
2026-04-30 03:39:59,785 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/2715559a-e713-4423-bdf1-fc98c7f5ff85
2026-04-30 03:39:59,797 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '15633955579822556234', 'uuid-lslong': '10478269097446666110'}, 'enable': 'true', 'created': '2026-04-30T03:39:59', 'last-modified': '2026-04-30T03:39:59', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.427162'}
2026-04-30 03:39:59,803 - DEBUG - Route Targets: ['target:64512:8000010']
2026-04-30 03:39:59,809 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '15633955579822556234', 'uuid-lslong': '10478269097446666110'}, 'enable': 'true', 'created': '2026-04-30T03:39:59', 'last-modified': '2026-04-30T03:39:59', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.443205'}
2026-04-30 03:39:59,814 - DEBUG - Route Targets: ['target:64512:8000010']
2026-04-30 03:39:59,819 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '15633955579822556234', 'uuid-lslong': '10478269097446666110'}, 'enable': 'true', 'created': '2026-04-30T03:39:59', 'last-modified': '2026-04-30T03:39:59', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.458409'}
2026-04-30 03:39:59,825 - DEBUG - Route Targets: ['target:64512:8000010']
2026-04-30 03:39:59,825 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-trans_left_vn-13004312 passed
2026-04-30 03:39:59,825 - DEBUG - ====Verifying policy data for ctest-trans_left_vn-13004312 in API_Server ======
2026-04-30 03:39:59,825 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:59,831 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:59,844 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:39:59,946 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/d8f6f7c4-818f-444a-916a-4a3a5642ef7e
2026-04-30 03:39:59,962 - DEBUG - =>VN ctest-trans_left_vn-13004312 has no policy to be verified
2026-04-30 03:39:59,962 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:59,962 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:59,962 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:59,976 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312?flat'}
2026-04-30 03:39:59,976 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:59,976 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:59,992 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312?flat'}
2026-04-30 03:39:59,992 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:59,992 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:40:00,009 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312?flat'}
2026-04-30 03:40:00,009 - INFO - Validated that VN default-domain:ctest-TestSvcHC-26467608:ctest-trans_left_vn-13004312 is found in opserver
2026-04-30 03:40:00,033 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:40:00,044 - DEBUG - VRF ids for VN ctest-trans_left_vn-13004312: {}
2026-04-30 03:40:00,344 - DEBUG - Response for create_network : {'network': {'id': '148ba8ee-73ea-4ede-9aaf-b05332b30536', 'name': 'ctest-trans_right_vn-97564112', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'project_id': '5167700159f74ab6870ae052f8a81c81', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcHC-26467608', 'ctest-trans_right_vn-97564112'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:40:00,593 - DEBUG - Response for create_subnet : {'subnet': {'id': 'b0875465-26e4-41c5-ae78-96efb0ba1062', 'name': '', 'tenant_id': '5167700159f74ab6870ae052f8a81c81', 'network_id': '148ba8ee-73ea-4ede-9aaf-b05332b30536', 'ip_version': 4, 'cidr': '155.71.211.192/26', 'allocation_pools': [{'start': '155.71.211.194', 'end': '155.71.211.254'}], 'gateway_ip': '155.71.211.193', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '155.71.211.194', 'tags': [], 'project_id': '5167700159f74ab6870ae052f8a81c81'}}
2026-04-30 03:40:00,618 - INFO - Created VN ctest-trans_right_vn-97564112
2026-04-30 03:40:00,632 - DEBUG - VN ctest-trans_right_vn-97564112 UUID is 148ba8ee-73ea-4ede-9aaf-b05332b30536
2026-04-30 03:40:00,714 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:40:00,720 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:40:00,731 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:40:00,838 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/148ba8ee-73ea-4ede-9aaf-b05332b30536
2026-04-30 03:40:00,851 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/148ba8ee-73ea-4ede-9aaf-b05332b30536
2026-04-30 03:40:00,862 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b3234d2a-7819-4f76-b18b-85b25ca8b02c
2026-04-30 03:40:00,873 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b3234d2a-7819-4f76-b18b-85b25ca8b02c
2026-04-30 03:40:00,881 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/662027cf-a9cd-4458-b378-2d0790034a98
2026-04-30 03:40:00,888 - DEBUG - Route Targets: ['target:64512:8000011']
2026-04-30 03:40:00,888 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/148ba8ee-73ea-4ede-9aaf-b05332b30536
2026-04-30 03:40:00,898 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b3234d2a-7819-4f76-b18b-85b25ca8b02c
2026-04-30 03:40:00,917 - INFO - Verified VN network id 21 for VN 148ba8ee-73ea-4ede-9aaf-b05332b30536
2026-04-30 03:40:00,917 - INFO - Verifications in API Server for VN ctest-trans_right_vn-97564112 passed
2026-04-30 03:40:00,917 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/148ba8ee-73ea-4ede-9aaf-b05332b30536
2026-04-30 03:40:00,929 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b3234d2a-7819-4f76-b18b-85b25ca8b02c
2026-04-30 03:40:00,938 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b3234d2a-7819-4f76-b18b-85b25ca8b02c
2026-04-30 03:40:00,955 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/662027cf-a9cd-4458-b378-2d0790034a98
2026-04-30 03:40:00,968 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '1480462644621758174', 'uuid-lslong': '11146321474144634166'}, 'enable': 'true', 'created': '2026-04-30T03:40:00', 'last-modified': '2026-04-30T03:40:00', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.437916'}
2026-04-30 03:40:00,973 - DEBUG - Route Targets: ['target:64512:8000011']
2026-04-30 03:40:00,981 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '1480462644621758174', 'uuid-lslong': '11146321474144634166'}, 'enable': 'true', 'created': '2026-04-30T03:40:00', 'last-modified': '2026-04-30T03:40:00', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.451032'}
2026-04-30 03:40:00,988 - DEBUG - Route Targets: ['target:64512:8000011']
2026-04-30 03:40:00,995 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcHC-26467608', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '1480462644621758174', 'uuid-lslong': '11146321474144634166'}, 'enable': 'true', 'created': '2026-04-30T03:40:00', 'last-modified': '2026-04-30T03:40:00', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.463008'}
2026-04-30 03:40:01,002 - DEBUG - Route Targets: ['target:64512:8000011']
2026-04-30 03:40:01,002 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-trans_right_vn-97564112 passed
2026-04-30 03:40:01,002 - DEBUG - ====Verifying policy data for ctest-trans_right_vn-97564112 in API_Server ======
2026-04-30 03:40:01,003 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:40:01,012 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:40:01,025 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:40:01,124 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/148ba8ee-73ea-4ede-9aaf-b05332b30536
2026-04-30 03:40:01,143 - DEBUG - =>VN ctest-trans_right_vn-97564112 has no policy to be verified
2026-04-30 03:40:01,143 - DEBUG - Verifying the vn in opserver
2026-04-30 03:40:01,143 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112 virtual network link through opserver 10.0.0.73
2026-04-30 03:40:01,143 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:40:01,158 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112?flat'}
2026-04-30 03:40:01,158 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112 virtual network link through opserver 10.0.0.141
2026-04-30 03:40:01,158 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:40:01,173 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112?flat'}
2026-04-30 03:40:01,173 - DEBUG - Verifying the default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112 virtual network link through opserver 10.0.0.33
2026-04-30 03:40:01,173 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:40:01,189 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112?flat'}
2026-04-30 03:40:01,189 - INFO - Validated that VN default-domain:ctest-TestSvcHC-26467608:ctest-trans_right_vn-97564112 is found in opserver
2026-04-30 03:40:01,216 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:40:01,229 - DEBUG - VRF ids for VN ctest-trans_right_vn-97564112: {}
2026-04-30 03:40:02,429 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-5725-1), Zone: (nova:an-jenkins-deploy-platform-ansible-os-5725-1)
2026-04-30 03:40:03,821 - INFO - VM ([]) created on node: (an-jenkins-deploy-platform-ansible-os-5725-2), Zone: (nova:an-jenkins-deploy-platform-ansible-os-5725-2)
2026-04-30 03:40:03,821 - DEBUG - Creating service template: ['default-domain', 'ctest-service_template_1-84599878']
2026-04-30 03:40:04,127 - DEBUG - Service template: ['default-domain', 'ctest-service_template_1-84599878'] created succesfully
2026-04-30 03:40:04,508 - DEBUG - Image by name tiny_trans_fw not found
2026-04-30 03:40:04,508 - DEBUG - Installing image tiny_trans_fw
2026-04-30 03:40:04,508 - DEBUG - Image info {'name': 'tinycore-net-transparent-fw.qcow2.gz', 'webserver': '', 'location': '/images/tinycore/', 'username': 'tc', 'password': 'secret', 'type': 'os', 'flavor': 'contrail_flavor_tiny', 'params': '--container-format bare --disk-format vmdk --property vmware_disktype="sparse" --property vmware_adaptertype="ide" --property hypervisor_type=qemu', 'name_docker': 'phusion-baseimage-enablesshd'}
2026-04-30 03:40:04,508 - DEBUG - Image build path file:///contrail-test/images/tinycore-net-transparent-fw.qcow2.gz
2026-04-30 03:40:04,508 - DEBUG - Download image from local file file:///contrail-test/images/tinycore-net-transparent-fw.qcow2.gz
2026-04-30 03:40:04,508 - DEBUG - Unzip image
2026-04-30 03:40:04,508 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: gunzip -f /contrail-test/images/tinycore-net-transparent-fw.qcow2.gz
2026-04-30 03:40:04,527 - INFO - image /contrail-test/images/tinycore-net-transparent-fw.qcow2 is not found
2026-04-30 03:40:04,528 - DEBUG - Deleting service template: ['default-domain', 'ctest-service_template_1-84599878']
2026-04-30 03:40:04,638 - INFO - Service template: ['default-domain', 'ctest-service_template_1-84599878'] deleted successfully.
2026-04-30 03:40:04,638 - INFO - Skip interface_detach for VM ctest-right_vm-51502760 in state BUILD
2026-04-30 03:40:04,638 - INFO - Deleting VM ctest-right_vm-51502760
2026-04-30 03:40:04,638 - ERROR - VM ctest-right_vm-51502760 has failed to come up
2026-04-30 03:40:04,638 - ERROR - Nova failed to get host of the VM
2026-04-30 03:40:04,638 - ERROR - VM ctest-right_vm-51502760 has failed to come up
2026-04-30 03:40:04,638 - ERROR - Nova failed to get host of the VM
2026-04-30 03:40:04,724 - INFO - Skip interface_detach for VM ctest-left_vm-51009259 in state BUILD
2026-04-30 03:40:04,724 - INFO - Deleting VM ctest-left_vm-51009259
2026-04-30 03:40:04,724 - ERROR - VM ctest-left_vm-51009259 has failed to come up
2026-04-30 03:40:04,724 - ERROR - Nova failed to get host of the VM
2026-04-30 03:40:04,724 - ERROR - VM ctest-left_vm-51009259 has failed to come up
2026-04-30 03:40:04,724 - ERROR - Nova failed to get host of the VM
2026-04-30 03:40:04,790 - INFO - Deleting VN ctest-trans_right_vn-97564112
2026-04-30 03:40:05,034 - DEBUG - Response for deleting network ()
2026-04-30 03:40:05,034 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b3234d2a-7819-4f76-b18b-85b25ca8b02c
2026-04-30 03:40:05,040 - DEBUG - Response Code: 404
2026-04-30 03:40:05,041 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:40:05,048 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:40:05,118 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:40:05,238 - INFO - Validated that VN ctest-trans_right_vn-97564112 is not found in API Server
2026-04-30 03:40:05,249 - DEBUG - VN ctest-trans_right_vn-97564112 is not present in Agent 10.0.0.19
2026-04-30 03:40:05,264 - DEBUG - VN ctest-trans_right_vn-97564112 is not present in Agent 10.0.0.241
2026-04-30 03:40:05,264 - INFO - Validated that VN ctest-trans_right_vn-97564112 is not in any agent
2026-04-30 03:40:05,313 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-trans_right_vn-97564112 info
2026-04-30 03:40:05,313 - INFO - Deleting VN ctest-trans_left_vn-13004312
2026-04-30 03:40:05,527 - DEBUG - Response for deleting network ()
2026-04-30 03:40:05,527 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/a0a5bef6-c521-4a98-be40-3258c33cc540
2026-04-30 03:40:05,544 - DEBUG - Response Code: 404
2026-04-30 03:40:05,544 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:40:05,558 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:40:05,575 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:40:05,697 - INFO - Validated that VN ctest-trans_left_vn-13004312 is not found in API Server
2026-04-30 03:40:05,707 - DEBUG - VN ctest-trans_left_vn-13004312 is not present in Agent 10.0.0.19
2026-04-30 03:40:05,720 - DEBUG - VN ctest-trans_left_vn-13004312 is not present in Agent 10.0.0.241
2026-04-30 03:40:05,720 - INFO - Validated that VN ctest-trans_left_vn-13004312 is not in any agent
2026-04-30 03:40:05,764 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-trans_left_vn-13004312 info
2026-04-30 03:40:05,764 - INFO - Deleting VN ctest-right_vn-62912183
2026-04-30 03:40:05,811 - DEBUG - VN a64f0db8-3b3e-46cd-8655-3639becdd928 still in use: Unable to complete operation on network a64f0db8-3b3e-46cd-8655-3639becdd928. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-43abe1fd-00c5-4826-830f-179e3624522c']
2026-04-30 03:40:05,812 - WARNING - Deleting VN ctest-right_vn-62912183 failed..Will retry
2026-04-30 03:40:08,017 - DEBUG - Response for deleting network ()
2026-04-30 03:40:08,017 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/3b16d6e4-c27a-42cc-b1e9-57ce4ee5a45f
2026-04-30 03:40:08,033 - DEBUG - Response Code: 404
2026-04-30 03:40:08,033 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:40:08,045 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:40:08,103 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:40:08,189 - INFO - Validated that VN ctest-right_vn-62912183 is not found in API Server
2026-04-30 03:40:08,199 - DEBUG - VN ctest-right_vn-62912183 is not present in Agent 10.0.0.19
2026-04-30 03:40:08,211 - DEBUG - VN ctest-right_vn-62912183 is not present in Agent 10.0.0.241
2026-04-30 03:40:08,211 - INFO - Validated that VN ctest-right_vn-62912183 is not in any agent
2026-04-30 03:40:08,253 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-right_vn-62912183 info
2026-04-30 03:40:08,253 - INFO - Deleting VN ctest-left_vn-51831725
2026-04-30 03:40:08,442 - DEBUG - Response for deleting network ()
2026-04-30 03:40:08,443 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/6d0098b4-f9a9-4433-8727-fb754ccec529
2026-04-30 03:40:08,456 - DEBUG - Response Code: 404
2026-04-30 03:40:08,456 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:40:08,461 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:40:08,473 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:40:08,561 - INFO - Validated that VN ctest-left_vn-51831725 is not found in API Server
2026-04-30 03:40:08,573 - DEBUG - VN ctest-left_vn-51831725 is not present in Agent 10.0.0.19
2026-04-30 03:40:08,586 - DEBUG - VN ctest-left_vn-51831725 is not present in Agent 10.0.0.241
2026-04-30 03:40:08,586 - INFO - Validated that VN ctest-left_vn-51831725 is not in any agent
2026-04-30 03:40:08,623 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-left_vn-51831725 info
2026-04-30 03:40:08,623 - INFO - Deleting VN ctest-mgmt_vn-33640056
2026-04-30 03:40:08,784 - DEBUG - Response for deleting network ()
2026-04-30 03:40:08,784 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/ff075641-f033-4c9b-b43a-a432f4298c0c
2026-04-30 03:40:08,797 - DEBUG - Response Code: 404
2026-04-30 03:40:08,798 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:40:08,806 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:40:08,823 - DEBUG - Requesting: http://10.0.0.73:8082/project/51677001-59f7-4ab6-870a-e052f8a81c81
2026-04-30 03:40:08,917 - INFO - Validated that VN ctest-mgmt_vn-33640056 is not found in API Server
2026-04-30 03:40:08,930 - DEBUG - VN ctest-mgmt_vn-33640056 is not present in Agent 10.0.0.19
2026-04-30 03:40:08,943 - DEBUG - VN ctest-mgmt_vn-33640056 is not present in Agent 10.0.0.241
2026-04-30 03:40:08,943 - INFO - Validated that VN ctest-mgmt_vn-33640056 is not in any agent
2026-04-30 03:40:08,978 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-mgmt_vn-33640056 info
2026-04-30 03:40:10,258 - DEBUG - No XMPP flaps were noticed during the test
2026-04-30 03:40:10,258 - INFO -
2026-04-30 03:40:10,259 - INFO - END TEST : test_svc_trans_segment_right_hc_fail_svm : SKIPPED[0:00:16]
2026-04-30 03:40:10,259 - INFO - --------------------------------------------------------------------------------
2026-04-30 03:40:11,018 - INFO - Deleted project: ctest-TestSvcHC-26467608, ID : 51677001-59f7-4ab6-870a-e052f8a81c81