]) 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:38:34,977 - DEBUG - Creating service template: ['default-domain', 'ctest-service_template_1-05001611']
2026-04-30 03:38:35,300 - DEBUG - Service template: ['default-domain', 'ctest-service_template_1-05001611'] created succesfully
2026-04-30 03:38:35,811 - DEBUG - Image by name tiny_nat_fw not found
2026-04-30 03:38:35,811 - DEBUG - Installing image tiny_nat_fw
2026-04-30 03:38:35,811 - 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:38:35,812 - DEBUG - Image build path http://nexus.opensdn.io/repository///images/tinycore//tinycore-in-network-nat.qcow2.gz
2026-04-30 03:38:35,813 - DEBUG - Download image from web http://nexus.opensdn.io/repository///images/tinycore//tinycore-in-network-nat.qcow2.gz
2026-04-30 03:38:35,828 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: wget -nv http://nexus.opensdn.io/repository///images/tinycore//tinycore-in-network-nat.qcow2.gz -O /contrail-test/images/tinycore-in-network-nat.qcow2.gz
2026-04-30 03:38:35,885 - DEBUG - Image has been downloaded to /contrail-test/images/tinycore-in-network-nat.qcow2.gz
2026-04-30 03:38:35,886 - DEBUG - Unzip image
2026-04-30 03:38:35,886 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: gunzip -f /contrail-test/images/tinycore-in-network-nat.qcow2.gz
2026-04-30 03:38:35,921 - INFO - image /contrail-test/images/tinycore-in-network-nat.qcow2 is not found
2026-04-30 03:38:35,922 - DEBUG - Deleting service template: ['default-domain', 'ctest-service_template_1-05001611']
2026-04-30 03:38:36,042 - INFO - Service template: ['default-domain', 'ctest-service_template_1-05001611'] deleted successfully.
2026-04-30 03:38:36,042 - INFO - Skip interface_detach for VM ctest-right_vm-42573545 in state BUILD
2026-04-30 03:38:36,042 - INFO - Deleting VM ctest-right_vm-42573545
2026-04-30 03:38:36,075 - ERROR - VM ctest-right_vm-42573545 has failed to come up
2026-04-30 03:38:36,075 - ERROR - Nova failed to get host of the VM
2026-04-30 03:38:36,075 - ERROR - VM ctest-right_vm-42573545 has failed to come up
2026-04-30 03:38:36,075 - ERROR - Nova failed to get host of the VM
2026-04-30 03:38:36,149 - INFO - Skip interface_detach for VM ctest-left_vm-82293508 in state BUILD
2026-04-30 03:38:36,150 - INFO - Deleting VM ctest-left_vm-82293508
2026-04-30 03:38:36,150 - ERROR - VM ctest-left_vm-82293508 has failed to come up
2026-04-30 03:38:36,150 - ERROR - Nova failed to get host of the VM
2026-04-30 03:38:36,150 - ERROR - VM ctest-left_vm-82293508 has failed to come up
2026-04-30 03:38:36,150 - ERROR - Nova failed to get host of the VM
2026-04-30 03:38:36,235 - INFO - Deleting VN ctest-right_vn-42326927
2026-04-30 03:38:36,280 - DEBUG - VN 5dc3f1f2-431e-45d2-aebd-5543103fe911 still in use: Unable to complete operation on network 5dc3f1f2-431e-45d2-aebd-5543103fe911. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-3c862e47-0294-4498-b669-478e01c7241d']
2026-04-30 03:38:36,280 - WARNING - Deleting VN ctest-right_vn-42326927 failed..Will retry
2026-04-30 03:38:38,441 - DEBUG - Response for deleting network ()
2026-04-30 03:38:38,442 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/376e4a5b-9ed5-44b3-8102-ca7221b1fc6c
2026-04-30 03:38:38,450 - DEBUG - Response Code: 404
2026-04-30 03:38:38,450 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:38,457 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:38,489 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:38,589 - INFO - Validated that VN ctest-right_vn-42326927 is not found in API Server
2026-04-30 03:38:38,602 - DEBUG - VN ctest-right_vn-42326927 is not present in Agent 10.0.0.19
2026-04-30 03:38:38,616 - DEBUG - VN ctest-right_vn-42326927 is not present in Agent 10.0.0.241
2026-04-30 03:38:38,616 - INFO - Validated that VN ctest-right_vn-42326927 is not in any agent
2026-04-30 03:38:38,657 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-right_vn-42326927 info
2026-04-30 03:38:38,657 - INFO - Deleting VN ctest-left_vn-64719277
2026-04-30 03:38:38,872 - DEBUG - Response for deleting network ()
2026-04-30 03:38:38,872 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/8c4bde8e-1261-4090-b714-5a12bc4d828f
2026-04-30 03:38:38,886 - DEBUG - Response Code: 404
2026-04-30 03:38:38,886 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:38,898 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:38,923 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:39,034 - INFO - Validated that VN ctest-left_vn-64719277 is not found in API Server
2026-04-30 03:38:39,049 - DEBUG - VN ctest-left_vn-64719277 is not present in Agent 10.0.0.19
2026-04-30 03:38:39,072 - DEBUG - VN ctest-left_vn-64719277 is not present in Agent 10.0.0.241
2026-04-30 03:38:39,072 - INFO - Validated that VN ctest-left_vn-64719277 is not in any agent
2026-04-30 03:38:39,126 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-left_vn-64719277 info
2026-04-30 03:38:39,126 - INFO - Deleting VN ctest-mgmt_vn-68072312
2026-04-30 03:38:39,291 - DEBUG - Response for deleting network ()
2026-04-30 03:38:39,291 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/e0c8a9d1-a153-469d-b49f-228d47df7409
2026-04-30 03:38:39,298 - DEBUG - Response Code: 404
2026-04-30 03:38:39,299 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:39,306 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:39,363 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:39,483 - INFO - Validated that VN ctest-mgmt_vn-68072312 is not found in API Server
2026-04-30 03:38:39,498 - DEBUG - VN ctest-mgmt_vn-68072312 is not present in Agent 10.0.0.19
2026-04-30 03:38:39,514 - DEBUG - VN ctest-mgmt_vn-68072312 is not present in Agent 10.0.0.241
2026-04-30 03:38:39,514 - INFO - Validated that VN ctest-mgmt_vn-68072312 is not in any agent
2026-04-30 03:38:39,555 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-mgmt_vn-68072312 info
2026-04-30 03:38:39,555 - INFO - Deleting VM ctest-vm-in-third-vn-32397912
2026-04-30 03:38:39,672 - INFO - Deleting VN ctest-third-vn-59918589
2026-04-30 03:38:39,729 - DEBUG - VN f9f6d1db-b229-409b-acf7-a6a46023867f still in use: Unable to complete operation on network f9f6d1db-b229-409b-acf7-a6a46023867f. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-8d651a8f-7597-40e1-989d-e30dcb5bf54a']
2026-04-30 03:38:39,729 - WARNING - Deleting VN ctest-third-vn-59918589 failed..Will retry
2026-04-30 03:38:41,935 - DEBUG - Response for deleting network ()
2026-04-30 03:38:43,209 - DEBUG - No XMPP flaps were noticed during the test
2026-04-30 03:38:43,209 - INFO -
2026-04-30 03:38:43,209 - INFO - END TEST : test_svc_in_net_nat_with_static_routes : SKIPPED[0:00:25]
2026-04-30 03:38:43,209 - INFO - --------------------------------------------------------------------------------
2026-04-30 03:38:43,213 - INFO - ================================================================================
2026-04-30 03:38:43,213 - INFO - STARTING TEST : test_svc_v2_transparent_datapath
2026-04-30 03:38:44,510 - 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:38:44,511 - INFO - Initial checks done. Running the testcase now
2026-04-30 03:38:44,511 - INFO -
2026-04-30 03:38:44,780 - DEBUG - Response for create_network : {'network': {'id': '793550b6-04a8-4a92-8173-bb2840fb7c17', 'name': 'ctest-mgmt_vn-32015816', 'tenant_id': 'f006a82b3e9948e0b1e6800df071d600', 'project_id': 'f006a82b3e9948e0b1e6800df071d600', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-38670702', 'ctest-mgmt_vn-32015816'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:38:45,066 - DEBUG - Response for create_subnet : {'subnet': {'id': 'c2de7096-0888-46ee-b6b7-0690fce6a515', 'name': '', 'tenant_id': 'f006a82b3e9948e0b1e6800df071d600', 'network_id': '793550b6-04a8-4a92-8173-bb2840fb7c17', 'ip_version': 4, 'cidr': '116.6.76.64/26', 'allocation_pools': [{'start': '116.6.76.66', 'end': '116.6.76.126'}], 'gateway_ip': '116.6.76.65', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '116.6.76.66', 'tags': [], 'project_id': 'f006a82b3e9948e0b1e6800df071d600'}}
2026-04-30 03:38:45,088 - INFO - Created VN ctest-mgmt_vn-32015816
2026-04-30 03:38:45,100 - DEBUG - VN ctest-mgmt_vn-32015816 UUID is 793550b6-04a8-4a92-8173-bb2840fb7c17
2026-04-30 03:38:45,171 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:45,177 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:45,187 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:45,272 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/793550b6-04a8-4a92-8173-bb2840fb7c17
2026-04-30 03:38:45,284 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/793550b6-04a8-4a92-8173-bb2840fb7c17
2026-04-30 03:38:45,294 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/aae64fda-ea7f-41d3-9480-73d41e650eb1
2026-04-30 03:38:45,303 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/aae64fda-ea7f-41d3-9480-73d41e650eb1
2026-04-30 03:38:45,311 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/92f41c34-fd87-4593-b76a-a323082cd8d0
2026-04-30 03:38:45,318 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:38:45,318 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/793550b6-04a8-4a92-8173-bb2840fb7c17
2026-04-30 03:38:45,326 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/aae64fda-ea7f-41d3-9480-73d41e650eb1
2026-04-30 03:38:45,340 - INFO - Verified VN network id 17 for VN 793550b6-04a8-4a92-8173-bb2840fb7c17
2026-04-30 03:38:45,340 - INFO - Verifications in API Server for VN ctest-mgmt_vn-32015816 passed
2026-04-30 03:38:45,340 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/793550b6-04a8-4a92-8173-bb2840fb7c17
2026-04-30 03:38:45,352 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/aae64fda-ea7f-41d3-9480-73d41e650eb1
2026-04-30 03:38:45,358 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/aae64fda-ea7f-41d3-9480-73d41e650eb1
2026-04-30 03:38:45,364 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/92f41c34-fd87-4593-b76a-a323082cd8d0
2026-04-30 03:38:45,375 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '8733975795047352978', 'uuid-lslong': '9328005034777738263'}, 'enable': 'true', 'created': '2026-04-30T03:38:44', 'last-modified': '2026-04-30T03:38:44', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.367012'}
2026-04-30 03:38:45,381 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:38:45,388 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '8733975795047352978', 'uuid-lslong': '9328005034777738263'}, 'enable': 'true', 'created': '2026-04-30T03:38:44', 'last-modified': '2026-04-30T03:38:44', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.378502'}
2026-04-30 03:38:45,394 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:38:45,399 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '8733975795047352978', 'uuid-lslong': '9328005034777738263'}, 'enable': 'true', 'created': '2026-04-30T03:38:44', 'last-modified': '2026-04-30T03:38:44', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.391192'}
2026-04-30 03:38:45,404 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:38:45,404 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-mgmt_vn-32015816 passed
2026-04-30 03:38:45,405 - DEBUG - ====Verifying policy data for ctest-mgmt_vn-32015816 in API_Server ======
2026-04-30 03:38:45,405 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:45,411 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:45,424 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:45,536 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/793550b6-04a8-4a92-8173-bb2840fb7c17
2026-04-30 03:38:45,546 - DEBUG - =>VN ctest-mgmt_vn-32015816 has no policy to be verified
2026-04-30 03:38:45,546 - DEBUG - Verifying the vn in opserver
2026-04-30 03:38:45,546 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816 virtual network link through opserver 10.0.0.73
2026-04-30 03:38:45,546 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:38:45,559 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816?flat'}
2026-04-30 03:38:45,559 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816 virtual network link through opserver 10.0.0.141
2026-04-30 03:38:45,559 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:38:45,574 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816?flat'}
2026-04-30 03:38:45,574 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816 virtual network link through opserver 10.0.0.33
2026-04-30 03:38:45,574 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:38:45,588 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816?flat'}
2026-04-30 03:38:45,588 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-38670702:ctest-mgmt_vn-32015816 is found in opserver
2026-04-30 03:38:45,621 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:38:45,639 - DEBUG - VRF ids for VN ctest-mgmt_vn-32015816: {}
2026-04-30 03:38:45,963 - DEBUG - Response for create_network : {'network': {'id': '73a6b6a5-f0f7-4c95-a442-7681b88460dc', 'name': 'ctest-left_vn-57559637', 'tenant_id': 'f006a82b3e9948e0b1e6800df071d600', 'project_id': 'f006a82b3e9948e0b1e6800df071d600', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-38670702', 'ctest-left_vn-57559637'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:38:46,208 - DEBUG - Response for create_subnet : {'subnet': {'id': 'b2b6c485-d312-4d20-a84d-799d684c024c', 'name': '', 'tenant_id': 'f006a82b3e9948e0b1e6800df071d600', 'network_id': '73a6b6a5-f0f7-4c95-a442-7681b88460dc', 'ip_version': 4, 'cidr': '93.24.161.0/26', 'allocation_pools': [{'start': '93.24.161.2', 'end': '93.24.161.62'}], 'gateway_ip': '93.24.161.1', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '93.24.161.2', 'tags': [], 'project_id': 'f006a82b3e9948e0b1e6800df071d600'}}
2026-04-30 03:38:46,229 - INFO - Created VN ctest-left_vn-57559637
2026-04-30 03:38:46,242 - DEBUG - VN ctest-left_vn-57559637 UUID is 73a6b6a5-f0f7-4c95-a442-7681b88460dc
2026-04-30 03:38:46,319 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:46,325 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:46,336 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:46,428 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/73a6b6a5-f0f7-4c95-a442-7681b88460dc
2026-04-30 03:38:46,442 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/73a6b6a5-f0f7-4c95-a442-7681b88460dc
2026-04-30 03:38:46,453 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/90f85b15-cad0-4dc8-89d0-e01fbaa0db30
2026-04-30 03:38:46,464 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/90f85b15-cad0-4dc8-89d0-e01fbaa0db30
2026-04-30 03:38:46,473 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/63cf8e77-d91d-4fb2-8af9-4227aa52e2a8
2026-04-30 03:38:46,483 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:38:46,483 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/73a6b6a5-f0f7-4c95-a442-7681b88460dc
2026-04-30 03:38:46,494 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/90f85b15-cad0-4dc8-89d0-e01fbaa0db30
2026-04-30 03:38:46,513 - INFO - Verified VN network id 18 for VN 73a6b6a5-f0f7-4c95-a442-7681b88460dc
2026-04-30 03:38:46,513 - INFO - Verifications in API Server for VN ctest-left_vn-57559637 passed
2026-04-30 03:38:46,513 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/73a6b6a5-f0f7-4c95-a442-7681b88460dc
2026-04-30 03:38:46,522 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/90f85b15-cad0-4dc8-89d0-e01fbaa0db30
2026-04-30 03:38:46,529 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/90f85b15-cad0-4dc8-89d0-e01fbaa0db30
2026-04-30 03:38:46,536 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/63cf8e77-d91d-4fb2-8af9-4227aa52e2a8
2026-04-30 03:38:46,547 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '8333548984324279445', 'uuid-lslong': '11836153070201626844'}, 'enable': 'true', 'created': '2026-04-30T03:38:45', 'last-modified': '2026-04-30T03:38:46', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.408920'}
2026-04-30 03:38:46,555 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:38:46,562 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '8333548984324279445', 'uuid-lslong': '11836153070201626844'}, 'enable': 'true', 'created': '2026-04-30T03:38:45', 'last-modified': '2026-04-30T03:38:46', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.419487'}
2026-04-30 03:38:46,568 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:38:46,574 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '8333548984324279445', 'uuid-lslong': '11836153070201626844'}, 'enable': 'true', 'created': '2026-04-30T03:38:45', 'last-modified': '2026-04-30T03:38:46', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.432016'}
2026-04-30 03:38:46,581 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:38:46,581 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-left_vn-57559637 passed
2026-04-30 03:38:46,581 - DEBUG - ====Verifying policy data for ctest-left_vn-57559637 in API_Server ======
2026-04-30 03:38:46,581 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:46,592 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:46,603 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:46,690 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/73a6b6a5-f0f7-4c95-a442-7681b88460dc
2026-04-30 03:38:46,701 - DEBUG - =>VN ctest-left_vn-57559637 has no policy to be verified
2026-04-30 03:38:46,701 - DEBUG - Verifying the vn in opserver
2026-04-30 03:38:46,701 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637 virtual network link through opserver 10.0.0.73
2026-04-30 03:38:46,701 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:38:46,719 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637?flat'}
2026-04-30 03:38:46,719 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637 virtual network link through opserver 10.0.0.141
2026-04-30 03:38:46,719 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:38:46,732 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637?flat'}
2026-04-30 03:38:46,733 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637 virtual network link through opserver 10.0.0.33
2026-04-30 03:38:46,733 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:38:46,746 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637?flat'}
2026-04-30 03:38:46,746 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-38670702:ctest-left_vn-57559637 is found in opserver
2026-04-30 03:38:46,772 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:38:46,788 - DEBUG - VRF ids for VN ctest-left_vn-57559637: {}
2026-04-30 03:38:47,072 - DEBUG - Response for create_network : {'network': {'id': '72d1bc62-f03d-4a64-a7fc-593b1e025300', 'name': 'ctest-right_vn-79349191', 'tenant_id': 'f006a82b3e9948e0b1e6800df071d600', 'project_id': 'f006a82b3e9948e0b1e6800df071d600', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-38670702', 'ctest-right_vn-79349191'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:38:47,290 - DEBUG - Response for create_subnet : {'subnet': {'id': '6f3d1d69-56ad-44aa-9ea0-de8fcd3e2d18', 'name': '', 'tenant_id': 'f006a82b3e9948e0b1e6800df071d600', 'network_id': '72d1bc62-f03d-4a64-a7fc-593b1e025300', 'ip_version': 4, 'cidr': '98.237.94.64/26', 'allocation_pools': [{'start': '98.237.94.66', 'end': '98.237.94.126'}], 'gateway_ip': '98.237.94.65', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '98.237.94.66', 'tags': [], 'project_id': 'f006a82b3e9948e0b1e6800df071d600'}}
2026-04-30 03:38:47,312 - INFO - Created VN ctest-right_vn-79349191
2026-04-30 03:38:47,326 - DEBUG - VN ctest-right_vn-79349191 UUID is 72d1bc62-f03d-4a64-a7fc-593b1e025300
2026-04-30 03:38:47,395 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:47,402 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:47,413 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:47,503 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/72d1bc62-f03d-4a64-a7fc-593b1e025300
2026-04-30 03:38:47,513 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/72d1bc62-f03d-4a64-a7fc-593b1e025300
2026-04-30 03:38:47,522 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f54fc3da-254a-43c5-877a-756802b3e7c9
2026-04-30 03:38:47,534 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f54fc3da-254a-43c5-877a-756802b3e7c9
2026-04-30 03:38:47,540 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/81aa6a88-4954-43bb-8894-5a822d8ede37
2026-04-30 03:38:47,547 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:38:47,547 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/72d1bc62-f03d-4a64-a7fc-593b1e025300
2026-04-30 03:38:47,555 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f54fc3da-254a-43c5-877a-756802b3e7c9
2026-04-30 03:38:47,570 - INFO - Verified VN network id 19 for VN 72d1bc62-f03d-4a64-a7fc-593b1e025300
2026-04-30 03:38:47,570 - INFO - Verifications in API Server for VN ctest-right_vn-79349191 passed
2026-04-30 03:38:47,570 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/72d1bc62-f03d-4a64-a7fc-593b1e025300
2026-04-30 03:38:47,582 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f54fc3da-254a-43c5-877a-756802b3e7c9
2026-04-30 03:38:47,589 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f54fc3da-254a-43c5-877a-756802b3e7c9
2026-04-30 03:38:47,597 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/81aa6a88-4954-43bb-8894-5a822d8ede37
2026-04-30 03:38:47,611 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '8273601123579677284', 'uuid-lslong': '12104648008906461952'}, 'enable': 'true', 'created': '2026-04-30T03:38:47', 'last-modified': '2026-04-30T03:38:47', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.387050'}
2026-04-30 03:38:47,617 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:38:47,626 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '8273601123579677284', 'uuid-lslong': '12104648008906461952'}, 'enable': 'true', 'created': '2026-04-30T03:38:47', 'last-modified': '2026-04-30T03:38:47', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.400936'}
2026-04-30 03:38:47,634 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:38:47,641 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '8273601123579677284', 'uuid-lslong': '12104648008906461952'}, 'enable': 'true', 'created': '2026-04-30T03:38:47', 'last-modified': '2026-04-30T03:38:47', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.414527'}
2026-04-30 03:38:47,648 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:38:47,649 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-right_vn-79349191 passed
2026-04-30 03:38:47,649 - DEBUG - ====Verifying policy data for ctest-right_vn-79349191 in API_Server ======
2026-04-30 03:38:47,649 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:47,659 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:47,673 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:47,777 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/72d1bc62-f03d-4a64-a7fc-593b1e025300
2026-04-30 03:38:47,788 - DEBUG - =>VN ctest-right_vn-79349191 has no policy to be verified
2026-04-30 03:38:47,788 - DEBUG - Verifying the vn in opserver
2026-04-30 03:38:47,788 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191 virtual network link through opserver 10.0.0.73
2026-04-30 03:38:47,788 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:38:47,801 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191?flat'}
2026-04-30 03:38:47,801 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191 virtual network link through opserver 10.0.0.141
2026-04-30 03:38:47,801 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:38:47,815 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191?flat'}
2026-04-30 03:38:47,815 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191 virtual network link through opserver 10.0.0.33
2026-04-30 03:38:47,815 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:38:47,827 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191?flat'}
2026-04-30 03:38:47,827 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-38670702:ctest-right_vn-79349191 is found in opserver
2026-04-30 03:38:47,852 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:38:47,864 - DEBUG - VRF ids for VN ctest-right_vn-79349191: {}
2026-04-30 03:38:48,154 - DEBUG - Response for create_network : {'network': {'id': '184932e9-c09f-41d5-9498-95e33950a2eb', 'name': 'ctest-trans_left_vn-62436858', 'tenant_id': 'f006a82b3e9948e0b1e6800df071d600', 'project_id': 'f006a82b3e9948e0b1e6800df071d600', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-38670702', 'ctest-trans_left_vn-62436858'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:38:48,413 - DEBUG - Response for create_subnet : {'subnet': {'id': '3b871cea-231f-4d65-8989-29bf6259778b', 'name': '', 'tenant_id': 'f006a82b3e9948e0b1e6800df071d600', 'network_id': '184932e9-c09f-41d5-9498-95e33950a2eb', 'ip_version': 4, 'cidr': '194.207.175.64/26', 'allocation_pools': [{'start': '194.207.175.66', 'end': '194.207.175.126'}], 'gateway_ip': '194.207.175.65', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '194.207.175.66', 'tags': [], 'project_id': 'f006a82b3e9948e0b1e6800df071d600'}}
2026-04-30 03:38:48,435 - INFO - Created VN ctest-trans_left_vn-62436858
2026-04-30 03:38:48,447 - DEBUG - VN ctest-trans_left_vn-62436858 UUID is 184932e9-c09f-41d5-9498-95e33950a2eb
2026-04-30 03:38:48,524 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:48,530 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:48,540 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:48,637 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/184932e9-c09f-41d5-9498-95e33950a2eb
2026-04-30 03:38:48,649 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/184932e9-c09f-41d5-9498-95e33950a2eb
2026-04-30 03:38:48,658 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/e4d4b1be-13e6-4ea8-a5c6-c511647acc1c
2026-04-30 03:38:48,665 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/e4d4b1be-13e6-4ea8-a5c6-c511647acc1c
2026-04-30 03:38:48,672 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/30a8ba7f-94b6-4507-b71c-421abed2d3ea
2026-04-30 03:38:48,682 - DEBUG - Route Targets: ['target:64512:8000010']
2026-04-30 03:38:48,682 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/184932e9-c09f-41d5-9498-95e33950a2eb
2026-04-30 03:38:48,695 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/e4d4b1be-13e6-4ea8-a5c6-c511647acc1c
2026-04-30 03:38:48,716 - INFO - Verified VN network id 20 for VN 184932e9-c09f-41d5-9498-95e33950a2eb
2026-04-30 03:38:48,716 - INFO - Verifications in API Server for VN ctest-trans_left_vn-62436858 passed
2026-04-30 03:38:48,717 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/184932e9-c09f-41d5-9498-95e33950a2eb
2026-04-30 03:38:48,730 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/e4d4b1be-13e6-4ea8-a5c6-c511647acc1c
2026-04-30 03:38:48,740 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/e4d4b1be-13e6-4ea8-a5c6-c511647acc1c
2026-04-30 03:38:48,749 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/30a8ba7f-94b6-4507-b71c-421abed2d3ea
2026-04-30 03:38:48,764 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '1749985909750579669', 'uuid-lslong': '10707472917225054955'}, 'enable': 'true', 'created': '2026-04-30T03:38:48', 'last-modified': '2026-04-30T03:38:48', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.415201'}
2026-04-30 03:38:48,773 - DEBUG - Route Targets: ['target:64512:8000010']
2026-04-30 03:38:48,780 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '1749985909750579669', 'uuid-lslong': '10707472917225054955'}, 'enable': 'true', 'created': '2026-04-30T03:38:48', 'last-modified': '2026-04-30T03:38:48', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.430578'}
2026-04-30 03:38:48,788 - DEBUG - Route Targets: ['target:64512:8000010']
2026-04-30 03:38:48,796 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '1749985909750579669', 'uuid-lslong': '10707472917225054955'}, 'enable': 'true', 'created': '2026-04-30T03:38:48', 'last-modified': '2026-04-30T03:38:48', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.445739'}
2026-04-30 03:38:48,805 - DEBUG - Route Targets: ['target:64512:8000010']
2026-04-30 03:38:48,805 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-trans_left_vn-62436858 passed
2026-04-30 03:38:48,805 - DEBUG - ====Verifying policy data for ctest-trans_left_vn-62436858 in API_Server ======
2026-04-30 03:38:48,806 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:48,813 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:48,828 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:48,931 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/184932e9-c09f-41d5-9498-95e33950a2eb
2026-04-30 03:38:48,942 - DEBUG - =>VN ctest-trans_left_vn-62436858 has no policy to be verified
2026-04-30 03:38:48,942 - DEBUG - Verifying the vn in opserver
2026-04-30 03:38:48,942 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858 virtual network link through opserver 10.0.0.73
2026-04-30 03:38:48,942 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:38:48,955 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858?flat'}
2026-04-30 03:38:48,955 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858 virtual network link through opserver 10.0.0.141
2026-04-30 03:38:48,955 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:38:48,969 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858?flat'}
2026-04-30 03:38:48,969 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858 virtual network link through opserver 10.0.0.33
2026-04-30 03:38:48,969 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:38:48,985 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858?flat'}
2026-04-30 03:38:48,985 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-38670702:ctest-trans_left_vn-62436858 is found in opserver
2026-04-30 03:38:49,007 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:38:49,020 - DEBUG - VRF ids for VN ctest-trans_left_vn-62436858: {}
2026-04-30 03:38:49,333 - DEBUG - Response for create_network : {'network': {'id': 'f15e5eae-1825-44d0-ab73-73c3f1638b2d', 'name': 'ctest-trans_right_vn-74040311', 'tenant_id': 'f006a82b3e9948e0b1e6800df071d600', 'project_id': 'f006a82b3e9948e0b1e6800df071d600', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-38670702', 'ctest-trans_right_vn-74040311'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:38:49,580 - DEBUG - Response for create_subnet : {'subnet': {'id': '2f1105da-9d9c-4984-9568-81211427f9ac', 'name': '', 'tenant_id': 'f006a82b3e9948e0b1e6800df071d600', 'network_id': 'f15e5eae-1825-44d0-ab73-73c3f1638b2d', 'ip_version': 4, 'cidr': '190.62.174.64/26', 'allocation_pools': [{'start': '190.62.174.66', 'end': '190.62.174.126'}], 'gateway_ip': '190.62.174.65', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '190.62.174.66', 'tags': [], 'project_id': 'f006a82b3e9948e0b1e6800df071d600'}}
2026-04-30 03:38:49,608 - INFO - Created VN ctest-trans_right_vn-74040311
2026-04-30 03:38:49,619 - DEBUG - VN ctest-trans_right_vn-74040311 UUID is f15e5eae-1825-44d0-ab73-73c3f1638b2d
2026-04-30 03:38:49,706 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:49,715 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:49,729 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:49,838 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/f15e5eae-1825-44d0-ab73-73c3f1638b2d
2026-04-30 03:38:49,860 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/f15e5eae-1825-44d0-ab73-73c3f1638b2d
2026-04-30 03:38:49,871 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/aba222c6-1487-46ce-a62a-56eead68ad1a
2026-04-30 03:38:49,882 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/aba222c6-1487-46ce-a62a-56eead68ad1a
2026-04-30 03:38:49,891 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/9f4f6411-485e-4a7e-b297-763270a16a68
2026-04-30 03:38:49,899 - DEBUG - Route Targets: ['target:64512:8000011']
2026-04-30 03:38:49,899 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/f15e5eae-1825-44d0-ab73-73c3f1638b2d
2026-04-30 03:38:49,911 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/aba222c6-1487-46ce-a62a-56eead68ad1a
2026-04-30 03:38:49,931 - INFO - Verified VN network id 21 for VN f15e5eae-1825-44d0-ab73-73c3f1638b2d
2026-04-30 03:38:49,931 - INFO - Verifications in API Server for VN ctest-trans_right_vn-74040311 passed
2026-04-30 03:38:49,932 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/f15e5eae-1825-44d0-ab73-73c3f1638b2d
2026-04-30 03:38:49,948 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/aba222c6-1487-46ce-a62a-56eead68ad1a
2026-04-30 03:38:49,960 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/aba222c6-1487-46ce-a62a-56eead68ad1a
2026-04-30 03:38:49,979 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/9f4f6411-485e-4a7e-b297-763270a16a68
2026-04-30 03:38:50,011 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '17392442912773850320', 'uuid-lslong': '12354345488213052205'}, 'enable': 'true', 'created': '2026-04-30T03:38:49', 'last-modified': '2026-04-30T03:38:49', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.493994'}
2026-04-30 03:38:50,022 - DEBUG - Route Targets: ['target:64512:8000011']
2026-04-30 03:38:50,029 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '17392442912773850320', 'uuid-lslong': '12354345488213052205'}, 'enable': 'true', 'created': '2026-04-30T03:38:49', 'last-modified': '2026-04-30T03:38:49', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.512898'}
2026-04-30 03:38:50,037 - DEBUG - Route Targets: ['target:64512:8000011']
2026-04-30 03:38:50,046 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-38670702', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '17392442912773850320', 'uuid-lslong': '12354345488213052205'}, 'enable': 'true', 'created': '2026-04-30T03:38:49', 'last-modified': '2026-04-30T03:38:49', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.529983'}
2026-04-30 03:38:50,054 - DEBUG - Route Targets: ['target:64512:8000011']
2026-04-30 03:38:50,055 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-trans_right_vn-74040311 passed
2026-04-30 03:38:50,055 - DEBUG - ====Verifying policy data for ctest-trans_right_vn-74040311 in API_Server ======
2026-04-30 03:38:50,055 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:50,064 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:50,081 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:50,189 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/f15e5eae-1825-44d0-ab73-73c3f1638b2d
2026-04-30 03:38:50,202 - DEBUG - =>VN ctest-trans_right_vn-74040311 has no policy to be verified
2026-04-30 03:38:50,203 - DEBUG - Verifying the vn in opserver
2026-04-30 03:38:50,203 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311 virtual network link through opserver 10.0.0.73
2026-04-30 03:38:50,203 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:38:50,218 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311?flat'}
2026-04-30 03:38:50,218 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311 virtual network link through opserver 10.0.0.141
2026-04-30 03:38:50,218 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:38:50,234 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311?flat'}
2026-04-30 03:38:50,234 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311 virtual network link through opserver 10.0.0.33
2026-04-30 03:38:50,234 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:38:50,249 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311?flat'}
2026-04-30 03:38:50,249 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-38670702:ctest-trans_right_vn-74040311 is found in opserver
2026-04-30 03:38:50,286 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:38:50,302 - DEBUG - VRF ids for VN ctest-trans_right_vn-74040311: {}
2026-04-30 03:38:51,655 - 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:38:53,068 - 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:38:53,068 - DEBUG - Creating service template: ['default-domain', 'ctest-service_template_1-03982599']
2026-04-30 03:38:53,385 - DEBUG - Service template: ['default-domain', 'ctest-service_template_1-03982599'] created succesfully
2026-04-30 03:38:53,851 - DEBUG - Image by name tiny_trans_fw not found
2026-04-30 03:38:53,852 - DEBUG - Installing image tiny_trans_fw
2026-04-30 03:38:53,852 - 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:38:53,852 - DEBUG - Image build path http://nexus.opensdn.io/repository///images/tinycore//tinycore-net-transparent-fw.qcow2.gz
2026-04-30 03:38:53,852 - DEBUG - Download image from web http://nexus.opensdn.io/repository///images/tinycore//tinycore-net-transparent-fw.qcow2.gz
2026-04-30 03:38:53,872 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: wget -nv http://nexus.opensdn.io/repository///images/tinycore//tinycore-net-transparent-fw.qcow2.gz -O /contrail-test/images/tinycore-net-transparent-fw.qcow2.gz
2026-04-30 03:38:53,901 - DEBUG - Image has been downloaded to /contrail-test/images/tinycore-net-transparent-fw.qcow2.gz
2026-04-30 03:38:53,901 - DEBUG - Unzip image
2026-04-30 03:38:53,901 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: gunzip -f /contrail-test/images/tinycore-net-transparent-fw.qcow2.gz
2026-04-30 03:38:53,920 - INFO - image /contrail-test/images/tinycore-net-transparent-fw.qcow2 is not found
2026-04-30 03:38:53,920 - DEBUG - Deleting service template: ['default-domain', 'ctest-service_template_1-03982599']
2026-04-30 03:38:54,019 - INFO - Service template: ['default-domain', 'ctest-service_template_1-03982599'] deleted successfully.
2026-04-30 03:38:54,023 - INFO - Skip interface_detach for VM ctest-right_vm-33429889 in state BUILD
2026-04-30 03:38:54,024 - INFO - Deleting VM ctest-right_vm-33429889
2026-04-30 03:38:54,026 - ERROR - VM ctest-right_vm-33429889 has failed to come up
2026-04-30 03:38:54,027 - ERROR - Nova failed to get host of the VM
2026-04-30 03:38:54,027 - ERROR - VM ctest-right_vm-33429889 has failed to come up
2026-04-30 03:38:54,028 - ERROR - Nova failed to get host of the VM
2026-04-30 03:38:54,200 - INFO - Skip interface_detach for VM ctest-left_vm-05791350 in state BUILD
2026-04-30 03:38:54,200 - INFO - Deleting VM ctest-left_vm-05791350
2026-04-30 03:38:54,200 - ERROR - VM ctest-left_vm-05791350 has failed to come up
2026-04-30 03:38:54,200 - ERROR - Nova failed to get host of the VM
2026-04-30 03:38:54,200 - ERROR - VM ctest-left_vm-05791350 has failed to come up
2026-04-30 03:38:54,200 - ERROR - Nova failed to get host of the VM
2026-04-30 03:38:54,285 - INFO - Deleting VN ctest-trans_right_vn-74040311
2026-04-30 03:38:54,448 - DEBUG - Response for deleting network ()
2026-04-30 03:38:54,449 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/aba222c6-1487-46ce-a62a-56eead68ad1a
2026-04-30 03:38:54,468 - DEBUG - Response Code: 404
2026-04-30 03:38:54,468 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:54,477 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:54,504 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:54,616 - INFO - Validated that VN ctest-trans_right_vn-74040311 is not found in API Server
2026-04-30 03:38:54,633 - DEBUG - VN ctest-trans_right_vn-74040311 is not present in Agent 10.0.0.19
2026-04-30 03:38:54,649 - DEBUG - VN ctest-trans_right_vn-74040311 is not present in Agent 10.0.0.241
2026-04-30 03:38:54,649 - INFO - Validated that VN ctest-trans_right_vn-74040311 is not in any agent
2026-04-30 03:38:54,687 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-trans_right_vn-74040311 info
2026-04-30 03:38:54,687 - INFO - Deleting VN ctest-trans_left_vn-62436858
2026-04-30 03:38:54,851 - DEBUG - Response for deleting network ()
2026-04-30 03:38:54,851 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/e4d4b1be-13e6-4ea8-a5c6-c511647acc1c
2026-04-30 03:38:54,858 - DEBUG - Response Code: 404
2026-04-30 03:38:54,858 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:54,866 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:54,889 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:54,984 - INFO - Validated that VN ctest-trans_left_vn-62436858 is not found in API Server
2026-04-30 03:38:55,004 - DEBUG - VN ctest-trans_left_vn-62436858 is not present in Agent 10.0.0.19
2026-04-30 03:38:55,020 - DEBUG - VN ctest-trans_left_vn-62436858 is not present in Agent 10.0.0.241
2026-04-30 03:38:55,020 - INFO - Validated that VN ctest-trans_left_vn-62436858 is not in any agent
2026-04-30 03:38:55,055 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-trans_left_vn-62436858 info
2026-04-30 03:38:55,056 - INFO - Deleting VN ctest-right_vn-79349191
2026-04-30 03:38:55,112 - DEBUG - VN 72d1bc62-f03d-4a64-a7fc-593b1e025300 still in use: Unable to complete operation on network 72d1bc62-f03d-4a64-a7fc-593b1e025300. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-df84b384-f6fb-4517-995e-746b4b8c2f90']
2026-04-30 03:38:55,112 - WARNING - Deleting VN ctest-right_vn-79349191 failed..Will retry
2026-04-30 03:38:57,277 - DEBUG - Response for deleting network ()
2026-04-30 03:38:57,277 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f54fc3da-254a-43c5-877a-756802b3e7c9
2026-04-30 03:38:57,283 - DEBUG - Response Code: 404
2026-04-30 03:38:57,283 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:57,288 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:57,344 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:57,441 - INFO - Validated that VN ctest-right_vn-79349191 is not found in API Server
2026-04-30 03:38:57,451 - DEBUG - VN ctest-right_vn-79349191 is not present in Agent 10.0.0.19
2026-04-30 03:38:57,461 - DEBUG - VN ctest-right_vn-79349191 is not present in Agent 10.0.0.241
2026-04-30 03:38:57,461 - INFO - Validated that VN ctest-right_vn-79349191 is not in any agent
2026-04-30 03:38:57,496 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-right_vn-79349191 info
2026-04-30 03:38:57,496 - INFO - Deleting VN ctest-left_vn-57559637
2026-04-30 03:38:57,656 - DEBUG - Response for deleting network ()
2026-04-30 03:38:57,656 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/90f85b15-cad0-4dc8-89d0-e01fbaa0db30
2026-04-30 03:38:57,661 - DEBUG - Response Code: 404
2026-04-30 03:38:57,662 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:57,666 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:57,682 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:57,768 - INFO - Validated that VN ctest-left_vn-57559637 is not found in API Server
2026-04-30 03:38:57,780 - DEBUG - VN ctest-left_vn-57559637 is not present in Agent 10.0.0.19
2026-04-30 03:38:57,793 - DEBUG - VN ctest-left_vn-57559637 is not present in Agent 10.0.0.241
2026-04-30 03:38:57,793 - INFO - Validated that VN ctest-left_vn-57559637 is not in any agent
2026-04-30 03:38:57,825 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-left_vn-57559637 info
2026-04-30 03:38:57,825 - INFO - Deleting VN ctest-mgmt_vn-32015816
2026-04-30 03:38:57,964 - DEBUG - Response for deleting network ()
2026-04-30 03:38:57,964 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/aae64fda-ea7f-41d3-9480-73d41e650eb1
2026-04-30 03:38:57,971 - DEBUG - Response Code: 404
2026-04-30 03:38:57,972 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:38:57,978 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:38:57,990 - DEBUG - Requesting: http://10.0.0.73:8082/project/f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:38:58,076 - INFO - Validated that VN ctest-mgmt_vn-32015816 is not found in API Server
2026-04-30 03:38:58,086 - DEBUG - VN ctest-mgmt_vn-32015816 is not present in Agent 10.0.0.19
2026-04-30 03:38:58,099 - DEBUG - VN ctest-mgmt_vn-32015816 is not present in Agent 10.0.0.241
2026-04-30 03:38:58,100 - INFO - Validated that VN ctest-mgmt_vn-32015816 is not in any agent
2026-04-30 03:38:58,127 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-mgmt_vn-32015816 info
2026-04-30 03:38:59,406 - DEBUG - No XMPP flaps were noticed during the test
2026-04-30 03:38:59,406 - INFO -
2026-04-30 03:38:59,406 - INFO - END TEST : test_svc_v2_transparent_datapath : SKIPPED[0:00:16]
2026-04-30 03:38:59,407 - INFO - --------------------------------------------------------------------------------
2026-04-30 03:39:00,142 - INFO - Deleted project: ctest-TestSvcRegr-38670702, ID : f006a82b-3e99-48e0-b1e6-800df071d600
2026-04-30 03:39:00,314 - INFO - Domain Default found not creating
2026-04-30 03:39:00,497 - INFO - Project ctest-TestSvcRegr-81110937 not found, creating it
2026-04-30 03:39:01,090 - INFO - Created Project:ctest-TestSvcRegr-81110937, ID : 5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:02,666 - INFO - ================================================================================
2026-04-30 03:39:02,666 - INFO - STARTING TEST : test_svc_CEM_22032
2026-04-30 03:39:03,956 - 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:03,957 - INFO - Initial checks done. Running the testcase now
2026-04-30 03:39:03,957 - INFO -
2026-04-30 03:39:04,653 - DEBUG - Response for create_network : {'network': {'id': '23603790-0824-4197-aafd-e1838ce42c7d', 'name': 'ctest-mgmt_vn-36191873', 'tenant_id': '5063801e1e504d7982c0caa365fed971', 'project_id': '5063801e1e504d7982c0caa365fed971', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-81110937', 'ctest-mgmt_vn-36191873'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:04,988 - DEBUG - Response for create_subnet : {'subnet': {'id': 'fb3571e1-dd58-40d7-b809-813af8d214c4', 'name': '', 'tenant_id': '5063801e1e504d7982c0caa365fed971', 'network_id': '23603790-0824-4197-aafd-e1838ce42c7d', 'ip_version': 4, 'cidr': '96.39.162.128/26', 'allocation_pools': [{'start': '96.39.162.130', 'end': '96.39.162.190'}], 'gateway_ip': '96.39.162.129', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '96.39.162.130', 'tags': [], 'project_id': '5063801e1e504d7982c0caa365fed971'}}
2026-04-30 03:39:05,010 - INFO - Created VN ctest-mgmt_vn-36191873
2026-04-30 03:39:05,023 - DEBUG - VN ctest-mgmt_vn-36191873 UUID is 23603790-0824-4197-aafd-e1838ce42c7d
2026-04-30 03:39:05,107 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:05,406 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:05,453 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:05,468 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:05,574 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/23603790-0824-4197-aafd-e1838ce42c7d
2026-04-30 03:39:05,606 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/23603790-0824-4197-aafd-e1838ce42c7d
2026-04-30 03:39:05,623 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b7b6ffb2-ba1c-4709-8039-5f1a9faff45e
2026-04-30 03:39:05,641 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b7b6ffb2-ba1c-4709-8039-5f1a9faff45e
2026-04-30 03:39:05,660 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/84cc819a-b6e2-4e18-be4a-a17e33ff8c49
2026-04-30 03:39:05,671 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:05,671 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/23603790-0824-4197-aafd-e1838ce42c7d
2026-04-30 03:39:05,683 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b7b6ffb2-ba1c-4709-8039-5f1a9faff45e
2026-04-30 03:39:05,699 - INFO - Verified VN network id 17 for VN 23603790-0824-4197-aafd-e1838ce42c7d
2026-04-30 03:39:05,700 - INFO - Verifications in API Server for VN ctest-mgmt_vn-36191873 passed
2026-04-30 03:39:05,700 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/23603790-0824-4197-aafd-e1838ce42c7d
2026-04-30 03:39:05,712 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b7b6ffb2-ba1c-4709-8039-5f1a9faff45e
2026-04-30 03:39:05,721 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b7b6ffb2-ba1c-4709-8039-5f1a9faff45e
2026-04-30 03:39:05,730 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/84cc819a-b6e2-4e18-be4a-a17e33ff8c49
2026-04-30 03:39:05,743 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '2549098480843112855', 'uuid-lslong': '12321252110676274301'}, 'enable': 'true', 'created': '2026-04-30T03:39:04', 'last-modified': '2026-04-30T03:39:04', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.867332'}
2026-04-30 03:39:05,764 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:05,771 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '2549098480843112855', 'uuid-lslong': '12321252110676274301'}, 'enable': 'true', 'created': '2026-04-30T03:39:04', 'last-modified': '2026-04-30T03:39:04', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.894767'}
2026-04-30 03:39:05,786 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:05,794 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '2549098480843112855', 'uuid-lslong': '12321252110676274301'}, 'enable': 'true', 'created': '2026-04-30T03:39:04', 'last-modified': '2026-04-30T03:39:04', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.916313'}
2026-04-30 03:39:05,800 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:05,800 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-mgmt_vn-36191873 passed
2026-04-30 03:39:05,801 - DEBUG - ====Verifying policy data for ctest-mgmt_vn-36191873 in API_Server ======
2026-04-30 03:39:05,801 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:05,806 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:05,835 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:05,949 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/23603790-0824-4197-aafd-e1838ce42c7d
2026-04-30 03:39:05,962 - DEBUG - =>VN ctest-mgmt_vn-36191873 has no policy to be verified
2026-04-30 03:39:05,962 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:05,962 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:05,962 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:06,312 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:06,406 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873?flat'}
2026-04-30 03:39:06,406 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:06,406 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:06,707 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:06,768 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873?flat'}
2026-04-30 03:39:06,768 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:06,769 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:07,079 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:07,165 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873?flat'}
2026-04-30 03:39:07,165 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-36191873 is found in opserver
2026-04-30 03:39:07,189 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:39:07,200 - DEBUG - VRF ids for VN ctest-mgmt_vn-36191873: {}
2026-04-30 03:39:07,479 - DEBUG - Response for create_network : {'network': {'id': 'b8d398d1-9a28-485a-8a89-ca6bc52483ea', 'name': 'service-left-vn-75492033', 'tenant_id': '5063801e1e504d7982c0caa365fed971', 'project_id': '5063801e1e504d7982c0caa365fed971', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-81110937', 'service-left-vn-75492033'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:07,772 - DEBUG - Response for create_subnet : {'subnet': {'id': '41479c7e-152c-4ce4-b796-112206a48f2b', 'name': '', 'tenant_id': '5063801e1e504d7982c0caa365fed971', 'network_id': 'b8d398d1-9a28-485a-8a89-ca6bc52483ea', 'ip_version': 4, 'cidr': '147.225.250.0/26', 'allocation_pools': [{'start': '147.225.250.2', 'end': '147.225.250.62'}], 'gateway_ip': '147.225.250.1', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '147.225.250.2', 'tags': [], 'project_id': '5063801e1e504d7982c0caa365fed971'}}
2026-04-30 03:39:07,791 - INFO - Created VN service-left-vn-75492033
2026-04-30 03:39:07,804 - DEBUG - VN service-left-vn-75492033 UUID is b8d398d1-9a28-485a-8a89-ca6bc52483ea
2026-04-30 03:39:07,885 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:07,894 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:07,907 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:08,001 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/b8d398d1-9a28-485a-8a89-ca6bc52483ea
2026-04-30 03:39:08,014 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/b8d398d1-9a28-485a-8a89-ca6bc52483ea
2026-04-30 03:39:08,024 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/a90fa5c9-7413-426b-8dc1-80e5d55c86f8
2026-04-30 03:39:08,034 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/a90fa5c9-7413-426b-8dc1-80e5d55c86f8
2026-04-30 03:39:08,041 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/4c083813-64b3-4603-b99a-7f62d0ce2a14
2026-04-30 03:39:08,048 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:08,048 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/b8d398d1-9a28-485a-8a89-ca6bc52483ea
2026-04-30 03:39:08,057 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/a90fa5c9-7413-426b-8dc1-80e5d55c86f8
2026-04-30 03:39:08,072 - INFO - Verified VN network id 18 for VN b8d398d1-9a28-485a-8a89-ca6bc52483ea
2026-04-30 03:39:08,072 - INFO - Verifications in API Server for VN service-left-vn-75492033 passed
2026-04-30 03:39:08,072 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/b8d398d1-9a28-485a-8a89-ca6bc52483ea
2026-04-30 03:39:08,081 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/a90fa5c9-7413-426b-8dc1-80e5d55c86f8
2026-04-30 03:39:08,090 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/a90fa5c9-7413-426b-8dc1-80e5d55c86f8
2026-04-30 03:39:08,096 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/4c083813-64b3-4603-b99a-7f62d0ce2a14
2026-04-30 03:39:08,107 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '13318156549066606682', 'uuid-lslong': '9982732613261231082'}, 'enable': 'true', 'created': '2026-04-30T03:39:07', 'last-modified': '2026-04-30T03:39:07', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.395626'}
2026-04-30 03:39:08,113 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:08,119 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '13318156549066606682', 'uuid-lslong': '9982732613261231082'}, 'enable': 'true', 'created': '2026-04-30T03:39:07', 'last-modified': '2026-04-30T03:39:07', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.407069'}
2026-04-30 03:39:08,127 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:08,132 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '13318156549066606682', 'uuid-lslong': '9982732613261231082'}, 'enable': 'true', 'created': '2026-04-30T03:39:07', 'last-modified': '2026-04-30T03:39:07', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.420853'}
2026-04-30 03:39:08,139 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:08,139 - INFO - On all control nodes, Config, RI and RT verification for VN service-left-vn-75492033 passed
2026-04-30 03:39:08,140 - DEBUG - ====Verifying policy data for service-left-vn-75492033 in API_Server ======
2026-04-30 03:39:08,140 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:08,146 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:08,157 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:08,252 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/b8d398d1-9a28-485a-8a89-ca6bc52483ea
2026-04-30 03:39:08,261 - DEBUG - =>VN service-left-vn-75492033 has no policy to be verified
2026-04-30 03:39:08,261 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:08,261 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:08,261 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:08,344 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033?flat'}
2026-04-30 03:39:08,344 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:08,344 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:08,420 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033?flat'}
2026-04-30 03:39:08,420 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:08,420 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:08,495 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033?flat'}
2026-04-30 03:39:08,496 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-81110937:service-left-vn-75492033 is found in opserver
2026-04-30 03:39:08,535 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:39:08,546 - DEBUG - VRF ids for VN service-left-vn-75492033: {}
2026-04-30 03:39:08,822 - DEBUG - Response for create_network : {'network': {'id': 'ffbe5917-e002-467d-9612-2f007e228388', 'name': 'service-right-vn-92045572', 'tenant_id': '5063801e1e504d7982c0caa365fed971', 'project_id': '5063801e1e504d7982c0caa365fed971', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-81110937', 'service-right-vn-92045572'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:09,054 - DEBUG - Response for create_subnet : {'subnet': {'id': '42364469-1d8f-4706-a895-d6edf0f52f2d', 'name': '', 'tenant_id': '5063801e1e504d7982c0caa365fed971', 'network_id': 'ffbe5917-e002-467d-9612-2f007e228388', 'ip_version': 4, 'cidr': '83.202.104.64/26', 'allocation_pools': [{'start': '83.202.104.66', 'end': '83.202.104.126'}], 'gateway_ip': '83.202.104.65', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '83.202.104.66', 'tags': [], 'project_id': '5063801e1e504d7982c0caa365fed971'}}
2026-04-30 03:39:09,083 - INFO - Created VN service-right-vn-92045572
2026-04-30 03:39:09,102 - DEBUG - VN service-right-vn-92045572 UUID is ffbe5917-e002-467d-9612-2f007e228388
2026-04-30 03:39:09,187 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:09,193 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:09,204 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:09,321 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/ffbe5917-e002-467d-9612-2f007e228388
2026-04-30 03:39:09,335 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/ffbe5917-e002-467d-9612-2f007e228388
2026-04-30 03:39:09,345 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/baf44111-980f-48c7-a382-9ff0621bd077
2026-04-30 03:39:09,359 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/baf44111-980f-48c7-a382-9ff0621bd077
2026-04-30 03:39:09,367 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/90b35608-e36d-4313-a9b0-7507e3fb832b
2026-04-30 03:39:09,374 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:09,374 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/ffbe5917-e002-467d-9612-2f007e228388
2026-04-30 03:39:09,384 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/baf44111-980f-48c7-a382-9ff0621bd077
2026-04-30 03:39:09,401 - INFO - Verified VN network id 19 for VN ffbe5917-e002-467d-9612-2f007e228388
2026-04-30 03:39:09,401 - INFO - Verifications in API Server for VN service-right-vn-92045572 passed
2026-04-30 03:39:09,401 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/ffbe5917-e002-467d-9612-2f007e228388
2026-04-30 03:39:09,413 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/baf44111-980f-48c7-a382-9ff0621bd077
2026-04-30 03:39:09,422 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/baf44111-980f-48c7-a382-9ff0621bd077
2026-04-30 03:39:09,432 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/90b35608-e36d-4313-a9b0-7507e3fb832b
2026-04-30 03:39:09,448 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '18428264684324013693', 'uuid-lslong': '10813757334432678792'}, 'enable': 'true', 'created': '2026-04-30T03:39:08', 'last-modified': '2026-04-30T03:39:08', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.449478'}
2026-04-30 03:39:09,456 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:09,463 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '18428264684324013693', 'uuid-lslong': '10813757334432678792'}, 'enable': 'true', 'created': '2026-04-30T03:39:08', 'last-modified': '2026-04-30T03:39:08', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.466483'}
2026-04-30 03:39:09,471 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:09,478 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '18428264684324013693', 'uuid-lslong': '10813757334432678792'}, 'enable': 'true', 'created': '2026-04-30T03:39:08', 'last-modified': '2026-04-30T03:39:08', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.474963'}
2026-04-30 03:39:09,484 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:09,485 - INFO - On all control nodes, Config, RI and RT verification for VN service-right-vn-92045572 passed
2026-04-30 03:39:09,485 - DEBUG - ====Verifying policy data for service-right-vn-92045572 in API_Server ======
2026-04-30 03:39:09,485 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:09,492 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:09,507 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:09,604 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/ffbe5917-e002-467d-9612-2f007e228388
2026-04-30 03:39:09,618 - DEBUG - =>VN service-right-vn-92045572 has no policy to be verified
2026-04-30 03:39:09,618 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:09,618 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:09,618 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:09,685 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572?flat'}
2026-04-30 03:39:09,685 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:09,686 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:09,776 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572?flat'}
2026-04-30 03:39:09,776 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:09,776 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:09,845 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572?flat'}
2026-04-30 03:39:09,845 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-81110937:service-right-vn-92045572 is found in opserver
2026-04-30 03:39:09,869 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:39:09,880 - DEBUG - VRF ids for VN service-right-vn-92045572: {}
2026-04-30 03:39:10,010 - DEBUG - Services list from nova: [, , , ]
2026-04-30 03:39:11,196 - 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:12,608 - 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:12,608 - DEBUG - Creating service template: ['default-domain', 'ctest-service_template_1-28214375']
2026-04-30 03:39:12,921 - DEBUG - Service template: ['default-domain', 'ctest-service_template_1-28214375'] created succesfully
2026-04-30 03:39:13,315 - DEBUG - Image by name tiny_nat_fw not found
2026-04-30 03:39:13,315 - DEBUG - Installing image tiny_nat_fw
2026-04-30 03:39:13,315 - 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:13,315 - DEBUG - Image build path file:///contrail-test/images/tinycore-in-network-nat.qcow2.gz
2026-04-30 03:39:13,316 - DEBUG - Download image from local file file:///contrail-test/images/tinycore-in-network-nat.qcow2.gz
2026-04-30 03:39:13,316 - DEBUG - Unzip image
2026-04-30 03:39:13,316 - 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:13,332 - INFO - image /contrail-test/images/tinycore-in-network-nat.qcow2 is not found
2026-04-30 03:39:13,332 - DEBUG - Deleting service template: ['default-domain', 'ctest-service_template_1-28214375']
2026-04-30 03:39:13,474 - INFO - Service template: ['default-domain', 'ctest-service_template_1-28214375'] deleted successfully.
2026-04-30 03:39:13,474 - INFO - Skip interface_detach for VM ctest-right_vm-45824906 in state BUILD
2026-04-30 03:39:13,474 - INFO - Deleting VM ctest-right_vm-45824906
2026-04-30 03:39:13,506 - ERROR - VM ctest-right_vm-45824906 has failed to come up
2026-04-30 03:39:13,507 - ERROR - Nova failed to get host of the VM
2026-04-30 03:39:13,507 - ERROR - VM ctest-right_vm-45824906 has failed to come up
2026-04-30 03:39:13,507 - ERROR - Nova failed to get host of the VM
2026-04-30 03:39:13,608 - INFO - Skip interface_detach for VM ctest-left_vm-39734011 in state BUILD
2026-04-30 03:39:13,608 - INFO - Deleting VM ctest-left_vm-39734011
2026-04-30 03:39:13,608 - ERROR - VM ctest-left_vm-39734011 has failed to come up
2026-04-30 03:39:13,608 - ERROR - Nova failed to get host of the VM
2026-04-30 03:39:13,608 - ERROR - VM ctest-left_vm-39734011 has failed to come up
2026-04-30 03:39:13,608 - ERROR - Nova failed to get host of the VM
2026-04-30 03:39:13,683 - INFO - Deleting VN service-right-vn-92045572
2026-04-30 03:39:13,731 - DEBUG - VN ffbe5917-e002-467d-9612-2f007e228388 still in use: Unable to complete operation on network ffbe5917-e002-467d-9612-2f007e228388. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-862757e0-7fd6-4dd4-8145-0c110e0c4fa6']
2026-04-30 03:39:13,731 - WARNING - Deleting VN service-right-vn-92045572 failed..Will retry
2026-04-30 03:39:15,920 - DEBUG - Response for deleting network ()
2026-04-30 03:39:15,920 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/baf44111-980f-48c7-a382-9ff0621bd077
2026-04-30 03:39:15,927 - DEBUG - Response Code: 404
2026-04-30 03:39:15,927 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:15,933 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:15,958 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:16,080 - INFO - Validated that VN service-right-vn-92045572 is not found in API Server
2026-04-30 03:39:16,097 - DEBUG - VN service-right-vn-92045572 is not present in Agent 10.0.0.19
2026-04-30 03:39:16,109 - DEBUG - VN service-right-vn-92045572 is not present in Agent 10.0.0.241
2026-04-30 03:39:16,109 - INFO - Validated that VN service-right-vn-92045572 is not in any agent
2026-04-30 03:39:16,146 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN service-right-vn-92045572 info
2026-04-30 03:39:16,146 - INFO - Deleting VN service-left-vn-75492033
2026-04-30 03:39:16,309 - DEBUG - Response for deleting network ()
2026-04-30 03:39:16,309 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/a90fa5c9-7413-426b-8dc1-80e5d55c86f8
2026-04-30 03:39:16,318 - DEBUG - Response Code: 404
2026-04-30 03:39:16,319 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:16,324 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:16,344 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:16,438 - INFO - Validated that VN service-left-vn-75492033 is not found in API Server
2026-04-30 03:39:16,454 - DEBUG - VN service-left-vn-75492033 is not present in Agent 10.0.0.19
2026-04-30 03:39:16,465 - DEBUG - VN service-left-vn-75492033 is not present in Agent 10.0.0.241
2026-04-30 03:39:16,466 - INFO - Validated that VN service-left-vn-75492033 is not in any agent
2026-04-30 03:39:16,499 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN service-left-vn-75492033 info
2026-04-30 03:39:16,499 - INFO - Deleting VN ctest-mgmt_vn-36191873
2026-04-30 03:39:16,656 - DEBUG - Response for deleting network ()
2026-04-30 03:39:16,656 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b7b6ffb2-ba1c-4709-8039-5f1a9faff45e
2026-04-30 03:39:16,662 - DEBUG - Response Code: 404
2026-04-30 03:39:16,662 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:16,677 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:16,692 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:16,788 - INFO - Validated that VN ctest-mgmt_vn-36191873 is not found in API Server
2026-04-30 03:39:16,802 - DEBUG - VN ctest-mgmt_vn-36191873 is not present in Agent 10.0.0.19
2026-04-30 03:39:16,813 - DEBUG - VN ctest-mgmt_vn-36191873 is not present in Agent 10.0.0.241
2026-04-30 03:39:16,813 - INFO - Validated that VN ctest-mgmt_vn-36191873 is not in any agent
2026-04-30 03:39:16,846 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-mgmt_vn-36191873 info
2026-04-30 03:39:18,140 - DEBUG - No XMPP flaps were noticed during the test
2026-04-30 03:39:18,140 - INFO -
2026-04-30 03:39:18,140 - INFO - END TEST : test_svc_CEM_22032 : SKIPPED[0:00:16]
2026-04-30 03:39:18,141 - INFO - --------------------------------------------------------------------------------
2026-04-30 03:39:18,143 - INFO - ================================================================================
2026-04-30 03:39:18,143 - INFO - STARTING TEST : test_svc_in_network_datapath
2026-04-30 03:39:19,461 - 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:19,461 - INFO - Initial checks done. Running the testcase now
2026-04-30 03:39:19,461 - INFO -
2026-04-30 03:39:19,733 - DEBUG - Response for create_network : {'network': {'id': '33b49be4-71ae-4077-a331-ec5b49955b22', 'name': 'ctest-mgmt_vn-97590397', 'tenant_id': '5063801e1e504d7982c0caa365fed971', 'project_id': '5063801e1e504d7982c0caa365fed971', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-81110937', 'ctest-mgmt_vn-97590397'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:19,929 - DEBUG - Response for create_subnet : {'subnet': {'id': 'cffbf60f-2cfb-4727-83fe-df58e3203f79', 'name': '', 'tenant_id': '5063801e1e504d7982c0caa365fed971', 'network_id': '33b49be4-71ae-4077-a331-ec5b49955b22', 'ip_version': 4, 'cidr': '119.109.189.128/26', 'allocation_pools': [{'start': '119.109.189.130', 'end': '119.109.189.190'}], 'gateway_ip': '119.109.189.129', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '119.109.189.130', 'tags': [], 'project_id': '5063801e1e504d7982c0caa365fed971'}}
2026-04-30 03:39:19,951 - INFO - Created VN ctest-mgmt_vn-97590397
2026-04-30 03:39:19,963 - DEBUG - VN ctest-mgmt_vn-97590397 UUID is 33b49be4-71ae-4077-a331-ec5b49955b22
2026-04-30 03:39:20,042 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:20,050 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:20,060 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:20,151 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/33b49be4-71ae-4077-a331-ec5b49955b22
2026-04-30 03:39:20,163 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/33b49be4-71ae-4077-a331-ec5b49955b22
2026-04-30 03:39:20,172 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/d336a608-acc0-4834-9200-ecc65c4d3544
2026-04-30 03:39:20,180 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/d336a608-acc0-4834-9200-ecc65c4d3544
2026-04-30 03:39:20,188 - DEBUG - Route Targets: []
2026-04-30 03:39:20,188 - DEBUG - RT names not yet present for VN ctest-mgmt_vn-97590397
2026-04-30 03:39:25,189 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:25,197 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:25,212 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:25,314 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/33b49be4-71ae-4077-a331-ec5b49955b22
2026-04-30 03:39:25,324 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/33b49be4-71ae-4077-a331-ec5b49955b22
2026-04-30 03:39:25,337 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/d336a608-acc0-4834-9200-ecc65c4d3544
2026-04-30 03:39:25,352 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/d336a608-acc0-4834-9200-ecc65c4d3544
2026-04-30 03:39:25,363 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/c4d83cd3-0393-4f18-afcc-7331d61b78d9
2026-04-30 03:39:25,369 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:25,370 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/33b49be4-71ae-4077-a331-ec5b49955b22
2026-04-30 03:39:25,379 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/d336a608-acc0-4834-9200-ecc65c4d3544
2026-04-30 03:39:25,396 - INFO - Verified VN network id 17 for VN 33b49be4-71ae-4077-a331-ec5b49955b22
2026-04-30 03:39:25,397 - INFO - Verifications in API Server for VN ctest-mgmt_vn-97590397 passed
2026-04-30 03:39:25,397 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/33b49be4-71ae-4077-a331-ec5b49955b22
2026-04-30 03:39:25,407 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/d336a608-acc0-4834-9200-ecc65c4d3544
2026-04-30 03:39:25,415 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/d336a608-acc0-4834-9200-ecc65c4d3544
2026-04-30 03:39:25,428 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/c4d83cd3-0393-4f18-afcc-7331d61b78d9
2026-04-30 03:39:25,439 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '3725774197204336759', 'uuid-lslong': '11759439978861779746'}, 'enable': 'true', 'created': '2026-04-30T03:39:19', 'last-modified': '2026-04-30T03:39:19', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:05.568384'}
2026-04-30 03:39:25,445 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:25,451 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '3725774197204336759', 'uuid-lslong': '11759439978861779746'}, 'enable': 'true', 'created': '2026-04-30T03:39:19', 'last-modified': '2026-04-30T03:39:19', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:05.579435'}
2026-04-30 03:39:25,457 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:25,463 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '3725774197204336759', 'uuid-lslong': '11759439978861779746'}, 'enable': 'true', 'created': '2026-04-30T03:39:19', 'last-modified': '2026-04-30T03:39:19', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:05.587487'}
2026-04-30 03:39:25,469 - DEBUG - Route Targets: ['target:64512:8000007']
2026-04-30 03:39:25,469 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-mgmt_vn-97590397 passed
2026-04-30 03:39:25,469 - DEBUG - ====Verifying policy data for ctest-mgmt_vn-97590397 in API_Server ======
2026-04-30 03:39:25,469 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:25,475 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:25,485 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:25,602 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/33b49be4-71ae-4077-a331-ec5b49955b22
2026-04-30 03:39:25,621 - DEBUG - =>VN ctest-mgmt_vn-97590397 has no policy to be verified
2026-04-30 03:39:25,621 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:25,621 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:25,621 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:25,645 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397?flat'}
2026-04-30 03:39:25,645 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:25,645 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:25,664 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397?flat'}
2026-04-30 03:39:25,664 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:25,664 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:25,678 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397?flat'}
2026-04-30 03:39:25,678 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-81110937:ctest-mgmt_vn-97590397 is found in opserver
2026-04-30 03:39:25,705 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:39:25,715 - DEBUG - VRF ids for VN ctest-mgmt_vn-97590397: {}
2026-04-30 03:39:25,983 - DEBUG - Response for create_network : {'network': {'id': '5b71238a-6fbd-4211-b485-0f7f2014f0f9', 'name': 'ctest-left_vn-29225693', 'tenant_id': '5063801e1e504d7982c0caa365fed971', 'project_id': '5063801e1e504d7982c0caa365fed971', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-81110937', 'ctest-left_vn-29225693'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:26,227 - DEBUG - Response for create_subnet : {'subnet': {'id': '0a1931cf-cb4a-4a22-893c-c33bc6f2ad01', 'name': '', 'tenant_id': '5063801e1e504d7982c0caa365fed971', 'network_id': '5b71238a-6fbd-4211-b485-0f7f2014f0f9', 'ip_version': 4, 'cidr': '156.251.81.192/26', 'allocation_pools': [{'start': '156.251.81.194', 'end': '156.251.81.254'}], 'gateway_ip': '156.251.81.193', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '156.251.81.194', 'tags': [], 'project_id': '5063801e1e504d7982c0caa365fed971'}}
2026-04-30 03:39:26,251 - INFO - Created VN ctest-left_vn-29225693
2026-04-30 03:39:26,264 - DEBUG - VN ctest-left_vn-29225693 UUID is 5b71238a-6fbd-4211-b485-0f7f2014f0f9
2026-04-30 03:39:26,345 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:26,354 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:26,367 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:26,466 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/5b71238a-6fbd-4211-b485-0f7f2014f0f9
2026-04-30 03:39:26,480 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/5b71238a-6fbd-4211-b485-0f7f2014f0f9
2026-04-30 03:39:26,493 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b927f8db-243b-4dfa-bdaf-1aa1cecee68e
2026-04-30 03:39:26,503 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b927f8db-243b-4dfa-bdaf-1aa1cecee68e
2026-04-30 03:39:26,511 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/a6660645-0760-4633-8f51-f6c71ba5d842
2026-04-30 03:39:26,518 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:26,518 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/5b71238a-6fbd-4211-b485-0f7f2014f0f9
2026-04-30 03:39:26,527 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b927f8db-243b-4dfa-bdaf-1aa1cecee68e
2026-04-30 03:39:26,544 - INFO - Verified VN network id 18 for VN 5b71238a-6fbd-4211-b485-0f7f2014f0f9
2026-04-30 03:39:26,544 - INFO - Verifications in API Server for VN ctest-left_vn-29225693 passed
2026-04-30 03:39:26,544 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/5b71238a-6fbd-4211-b485-0f7f2014f0f9
2026-04-30 03:39:26,557 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b927f8db-243b-4dfa-bdaf-1aa1cecee68e
2026-04-30 03:39:26,568 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b927f8db-243b-4dfa-bdaf-1aa1cecee68e
2026-04-30 03:39:26,578 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/a6660645-0760-4633-8f51-f6c71ba5d842
2026-04-30 03:39:26,590 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '6589086807306879505', 'uuid-lslong': '13007820137403052281'}, 'enable': 'true', 'created': '2026-04-30T03:39:25', 'last-modified': '2026-04-30T03:39:26', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.414963'}
2026-04-30 03:39:26,596 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:26,603 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '6589086807306879505', 'uuid-lslong': '13007820137403052281'}, 'enable': 'true', 'created': '2026-04-30T03:39:25', 'last-modified': '2026-04-30T03:39:26', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.433364'}
2026-04-30 03:39:26,609 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:26,614 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '6589086807306879505', 'uuid-lslong': '13007820137403052281'}, 'enable': 'true', 'created': '2026-04-30T03:39:25', 'last-modified': '2026-04-30T03:39:26', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.454378'}
2026-04-30 03:39:26,620 - DEBUG - Route Targets: ['target:64512:8000008']
2026-04-30 03:39:26,620 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-left_vn-29225693 passed
2026-04-30 03:39:26,620 - DEBUG - ====Verifying policy data for ctest-left_vn-29225693 in API_Server ======
2026-04-30 03:39:26,620 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:26,627 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:26,639 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:26,729 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/5b71238a-6fbd-4211-b485-0f7f2014f0f9
2026-04-30 03:39:26,750 - DEBUG - =>VN ctest-left_vn-29225693 has no policy to be verified
2026-04-30 03:39:26,750 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:26,750 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:26,750 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:26,763 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693?flat'}
2026-04-30 03:39:26,763 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:26,763 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:26,777 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693?flat'}
2026-04-30 03:39:26,777 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:26,777 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:26,793 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693?flat'}
2026-04-30 03:39:26,793 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-81110937:ctest-left_vn-29225693 is found in opserver
2026-04-30 03:39:26,815 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:39:26,836 - DEBUG - VRF ids for VN ctest-left_vn-29225693: {}
2026-04-30 03:39:27,118 - DEBUG - Response for create_network : {'network': {'id': 'ea4a478f-7803-49da-a977-a147ac0b55fd', 'name': 'ctest-right_vn-62823010', 'tenant_id': '5063801e1e504d7982c0caa365fed971', 'project_id': '5063801e1e504d7982c0caa365fed971', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestSvcRegr-81110937', 'ctest-right_vn-62823010'], 'port_security_enabled': True, 'description': ''}}
2026-04-30 03:39:27,374 - DEBUG - Response for create_subnet : {'subnet': {'id': '440e2556-488a-4259-bdc4-d781c55de3cd', 'name': '', 'tenant_id': '5063801e1e504d7982c0caa365fed971', 'network_id': 'ea4a478f-7803-49da-a977-a147ac0b55fd', 'ip_version': 4, 'cidr': '102.25.125.128/26', 'allocation_pools': [{'start': '102.25.125.130', 'end': '102.25.125.190'}], 'gateway_ip': '102.25.125.129', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '102.25.125.130', 'tags': [], 'project_id': '5063801e1e504d7982c0caa365fed971'}}
2026-04-30 03:39:27,397 - INFO - Created VN ctest-right_vn-62823010
2026-04-30 03:39:27,410 - DEBUG - VN ctest-right_vn-62823010 UUID is ea4a478f-7803-49da-a977-a147ac0b55fd
2026-04-30 03:39:27,481 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:27,487 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:27,498 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:27,598 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/ea4a478f-7803-49da-a977-a147ac0b55fd
2026-04-30 03:39:27,610 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/ea4a478f-7803-49da-a977-a147ac0b55fd
2026-04-30 03:39:27,619 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f4577ec7-8886-4b95-9d18-397e81f84a0d
2026-04-30 03:39:27,626 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f4577ec7-8886-4b95-9d18-397e81f84a0d
2026-04-30 03:39:27,632 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/4aedb9d4-1700-4b0e-b3f6-124220bd0da0
2026-04-30 03:39:27,639 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:27,639 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/ea4a478f-7803-49da-a977-a147ac0b55fd
2026-04-30 03:39:27,648 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f4577ec7-8886-4b95-9d18-397e81f84a0d
2026-04-30 03:39:27,667 - INFO - Verified VN network id 19 for VN ea4a478f-7803-49da-a977-a147ac0b55fd
2026-04-30 03:39:27,667 - INFO - Verifications in API Server for VN ctest-right_vn-62823010 passed
2026-04-30 03:39:27,667 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/ea4a478f-7803-49da-a977-a147ac0b55fd
2026-04-30 03:39:27,677 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f4577ec7-8886-4b95-9d18-397e81f84a0d
2026-04-30 03:39:27,685 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f4577ec7-8886-4b95-9d18-397e81f84a0d
2026-04-30 03:39:27,692 - DEBUG - Requesting: http://10.0.0.73:8082/route-target/4aedb9d4-1700-4b0e-b3f6-124220bd0da0
2026-04-30 03:39:27,703 - DEBUG - Control-node 10.0.0.73 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '16882384834671102426', 'uuid-lslong': '12211406243839563261'}, 'enable': 'true', 'created': '2026-04-30T03:39:27', 'last-modified': '2026-04-30T03:39:27', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.379855'}
2026-04-30 03:39:27,708 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:27,715 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '16882384834671102426', 'uuid-lslong': '12211406243839563261'}, 'enable': 'true', 'created': '2026-04-30T03:39:27', 'last-modified': '2026-04-30T03:39:27', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.391283'}
2026-04-30 03:39:27,720 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:27,726 - DEBUG - Control-node 10.0.0.33 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestSvcRegr-81110937', 'owner-access': '7', 'group': 'reader', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '16882384834671102426', 'uuid-lslong': '12211406243839563261'}, 'enable': 'true', 'created': '2026-04-30T03:39:27', 'last-modified': '2026-04-30T03:39:27', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.404534'}
2026-04-30 03:39:27,732 - DEBUG - Route Targets: ['target:64512:8000009']
2026-04-30 03:39:27,732 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-right_vn-62823010 passed
2026-04-30 03:39:27,732 - DEBUG - ====Verifying policy data for ctest-right_vn-62823010 in API_Server ======
2026-04-30 03:39:27,732 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:27,738 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:27,748 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:27,840 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-network/ea4a478f-7803-49da-a977-a147ac0b55fd
2026-04-30 03:39:27,852 - DEBUG - =>VN ctest-right_vn-62823010 has no policy to be verified
2026-04-30 03:39:27,852 - DEBUG - Verifying the vn in opserver
2026-04-30 03:39:27,852 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010 virtual network link through opserver 10.0.0.73
2026-04-30 03:39:27,852 - DEBUG - Requesting: http://10.0.0.73:8081/analytics/uves/virtual-networks
2026-04-30 03:39:27,864 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010', 'href': 'http://10.0.0.73:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010?flat'}
2026-04-30 03:39:27,864 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010 virtual network link through opserver 10.0.0.141
2026-04-30 03:39:27,864 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2026-04-30 03:39:27,883 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010?flat'}
2026-04-30 03:39:27,883 - DEBUG - Verifying the default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010 virtual network link through opserver 10.0.0.33
2026-04-30 03:39:27,883 - DEBUG - Requesting: http://10.0.0.33:8081/analytics/uves/virtual-networks
2026-04-30 03:39:27,897 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010', 'href': 'http://10.0.0.33:8081/analytics/uves/virtual-network/default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010?flat'}
2026-04-30 03:39:27,897 - INFO - Validated that VN default-domain:ctest-TestSvcRegr-81110937:ctest-right_vn-62823010 is found in opserver
2026-04-30 03:39:27,926 - DEBUG - Do not have enough data to verify VN in agent
2026-04-30 03:39:27,937 - DEBUG - VRF ids for VN ctest-right_vn-62823010: {}
2026-04-30 03:39:29,165 - 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:30,548 - 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:30,549 - DEBUG - Creating service template: ['default-domain', 'ctest-service_template_1-30879702']
2026-04-30 03:39:30,860 - DEBUG - Service template: ['default-domain', 'ctest-service_template_1-30879702'] created succesfully
2026-04-30 03:39:31,221 - DEBUG - Image by name tiny_nat_fw not found
2026-04-30 03:39:31,221 - DEBUG - Installing image tiny_nat_fw
2026-04-30 03:39:31,221 - 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:31,221 - DEBUG - Image build path file:///contrail-test/images/tinycore-in-network-nat.qcow2.gz
2026-04-30 03:39:31,221 - DEBUG - Download image from local file file:///contrail-test/images/tinycore-in-network-nat.qcow2.gz
2026-04-30 03:39:31,221 - DEBUG - Unzip image
2026-04-30 03:39:31,221 - 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:31,239 - INFO - image /contrail-test/images/tinycore-in-network-nat.qcow2 is not found
2026-04-30 03:39:31,239 - DEBUG - Deleting service template: ['default-domain', 'ctest-service_template_1-30879702']
2026-04-30 03:39:31,362 - INFO - Service template: ['default-domain', 'ctest-service_template_1-30879702'] deleted successfully.
2026-04-30 03:39:31,362 - INFO - Skip interface_detach for VM ctest-right_vm-96971257 in state BUILD
2026-04-30 03:39:31,363 - INFO - Deleting VM ctest-right_vm-96971257
2026-04-30 03:39:31,363 - ERROR - VM ctest-right_vm-96971257 has failed to come up
2026-04-30 03:39:31,363 - ERROR - Nova failed to get host of the VM
2026-04-30 03:39:31,363 - ERROR - VM ctest-right_vm-96971257 has failed to come up
2026-04-30 03:39:31,363 - ERROR - Nova failed to get host of the VM
2026-04-30 03:39:31,465 - INFO - Skip interface_detach for VM ctest-left_vm-60237761 in state BUILD
2026-04-30 03:39:31,466 - INFO - Deleting VM ctest-left_vm-60237761
2026-04-30 03:39:31,466 - ERROR - VM ctest-left_vm-60237761 has failed to come up
2026-04-30 03:39:31,466 - ERROR - Nova failed to get host of the VM
2026-04-30 03:39:31,466 - ERROR - VM ctest-left_vm-60237761 has failed to come up
2026-04-30 03:39:31,466 - ERROR - Nova failed to get host of the VM
2026-04-30 03:39:31,559 - INFO - Deleting VN ctest-right_vn-62823010
2026-04-30 03:39:31,611 - DEBUG - VN ea4a478f-7803-49da-a977-a147ac0b55fd still in use: Unable to complete operation on network ea4a478f-7803-49da-a977-a147ac0b55fd. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-89cc915b-3803-487a-b3de-5fd78160f68d']
2026-04-30 03:39:31,612 - WARNING - Deleting VN ctest-right_vn-62823010 failed..Will retry
2026-04-30 03:39:33,784 - DEBUG - Response for deleting network ()
2026-04-30 03:39:33,784 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/f4577ec7-8886-4b95-9d18-397e81f84a0d
2026-04-30 03:39:33,790 - DEBUG - Response Code: 404
2026-04-30 03:39:33,790 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:33,795 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:33,819 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:33,916 - INFO - Validated that VN ctest-right_vn-62823010 is not found in API Server
2026-04-30 03:39:33,930 - DEBUG - VN ctest-right_vn-62823010 is not present in Agent 10.0.0.19
2026-04-30 03:39:33,946 - DEBUG - VN ctest-right_vn-62823010 is not present in Agent 10.0.0.241
2026-04-30 03:39:33,946 - INFO - Validated that VN ctest-right_vn-62823010 is not in any agent
2026-04-30 03:39:33,976 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-right_vn-62823010 info
2026-04-30 03:39:33,976 - INFO - Deleting VN ctest-left_vn-29225693
2026-04-30 03:39:34,139 - DEBUG - Response for deleting network ()
2026-04-30 03:39:34,139 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/b927f8db-243b-4dfa-bdaf-1aa1cecee68e
2026-04-30 03:39:34,145 - DEBUG - Response Code: 404
2026-04-30 03:39:34,145 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:34,153 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:34,174 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:34,262 - INFO - Validated that VN ctest-left_vn-29225693 is not found in API Server
2026-04-30 03:39:34,274 - DEBUG - VN ctest-left_vn-29225693 is not present in Agent 10.0.0.19
2026-04-30 03:39:34,285 - DEBUG - VN ctest-left_vn-29225693 is not present in Agent 10.0.0.241
2026-04-30 03:39:34,285 - INFO - Validated that VN ctest-left_vn-29225693 is not in any agent
2026-04-30 03:39:34,317 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-left_vn-29225693 info
2026-04-30 03:39:34,318 - INFO - Deleting VN ctest-mgmt_vn-97590397
2026-04-30 03:39:34,475 - DEBUG - Response for deleting network ()
2026-04-30 03:39:34,475 - DEBUG - Requesting: http://10.0.0.73:8082/routing-instance/d336a608-acc0-4834-9200-ecc65c4d3544
2026-04-30 03:39:34,490 - DEBUG - Response Code: 404
2026-04-30 03:39:34,490 - DEBUG - Requesting: http://10.0.0.73:8082/domains
2026-04-30 03:39:34,497 - DEBUG - Requesting: http://10.0.0.73:8082/domain/f8fddec0-a757-47f7-9dc4-33479425fadb
2026-04-30 03:39:34,510 - DEBUG - Requesting: http://10.0.0.73:8082/project/5063801e-1e50-4d79-82c0-caa365fed971
2026-04-30 03:39:34,622 - INFO - Validated that VN ctest-mgmt_vn-97590397 is not found in API Server
2026-04-30 03:39:34,632 - DEBUG - VN ctest-mgmt_vn-97590397 is not present in Agent 10.0.0.19
2026-04-30 03:39:34,644 - DEBUG - VN ctest-mgmt_vn-97590397 is not present in Agent 10.0.0.241
2026-04-30 03:39:34,644 - INFO - Validated that VN ctest-mgmt_vn-97590397 is not in any agent
2026-04-30 03:39:34,677 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-mgmt_vn-97590397 info
2026-04-30 03:39:35,971 - DEBUG - No XMPP flaps were noticed during the test
2026-04-30 03:39:35,977 - INFO -
2026-04-30 03:39:35,977 - INFO - END TEST : test_svc_in_network_datapath : SKIPPED[0:00:17]
2026-04-30 03:39:35,977 - INFO - --------------------------------------------------------------------------------
2026-04-30 03:39:36,841 - INFO - Deleted project: ctest-TestSvcRegr-81110937, ID : 5063801e-1e50-4d79-82c0-caa365fed971