is in ACTIVE state now
2025-10-29 13:10:10,896 - INFO - VM name : mltf_vm
2025-10-29 13:10:11,007 - DEBUG - VM mltf_vm ID is d6305405-dfd1-4691-8870-9ce88027c682
2025-10-29 13:10:11,007 - DEBUG - VM mltf_vm launched on Node an-jenkins-deploy-platform-ansible-os-4521-2
2025-10-29 13:10:11,206 - DEBUG - Requesting: http://10.0.0.48:8082/virtual-machine/d6305405-dfd1-4691-8870-9ce88027c682
2025-10-29 13:10:11,220 - DEBUG - Requesting: http://10.0.0.48:8082/virtual-machine-interface/3754a7ca-476e-4064-a0ec-80b5d645e56e
2025-10-29 13:10:11,234 - DEBUG - Requesting: http://10.0.0.48:8082/virtual-machine-interface/b6016283-e20a-40d9-a819-22bc3fc8f6fc
2025-10-29 13:10:12,425 - DEBUG - (True, 'PING 169.254.0.5 (169.254.0.5) 56(84) bytes of data.\r\n64 bytes from 169.254.0.5: icmp_seq=1 ttl=63 time=2.66 ms\r\n64 bytes from 169.254.0.5: icmp_seq=2 ttl=63 time=0.508 ms\r\n\r\n--- 169.254.0.5 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1001ms\r\nrtt min/avg/max/mdev = 0.508/1.584/2.661/1.076 ms')
2025-10-29 13:10:12,425 - INFO - Ping to Metadata IP 169.254.0.5 of VM mltf_vm passed
2025-10-29 13:10:12,498 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-10-29 13:10:12,499 - DEBUG - Waiting to SSH to VM mltf_vm, IP 40.101.173.197, Port 22
2025-10-29 13:10:12,671 - DEBUG - VM mltf_vm is ready for SSH connections
2025-10-29 13:10:12,747 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2025-10-29 13:10:12,747 - DEBUG - Waiting to SSH to VM mltf_vm, IP 40.101.173.197, Port 22
2025-10-29 13:10:12,914 - DEBUG - VM mltf_vm is ready for SSH connections
2025-10-29 13:10:12,917 - INFO - ================================================================================
2025-10-29 13:10:12,917 - INFO - STARTING TEST : test_verify_session_sampling_teardown
2025-10-29 13:10:12,917 - INFO - TEST DESCRIPTION :
1.query client session samples
2.query server session samples
3.query client session to get number of sessions exported
4.query session record table for teardown bytes/pkts
5.query sample count after teardown on server side
2025-10-29 13:10:14,228 - DEBUG - Skipping xmpp flap check
2025-10-29 13:10:14,229 - INFO - Initial checks done. Running the testcase now
2025-10-29 13:10:14,229 - INFO -
2025-10-29 13:10:14,368 - INFO - Setting flow export rate: 100
2025-10-29 13:10:14,420 - DEBUG - Policy np_rules : [rule_sequence = None, rule_uuid = None, direction = <>, protocol = icmp, src_addresses = [subnet = None, virtual_network = any, security_group = None, network_policy = None, subnet_list = []], src_ports = [start_port = -1, end_port = -1], application = [], dst_addresses = [subnet = None, virtual_network = any, security_group = None, network_policy = None, subnet_list = []], dst_ports = [start_port = -1, end_port = -1], action_list = simple_action = pass, gateway_name = None, apply_service = [], service_properties = None, mirror_to = None, assign_routing_instance = None, log = False, alert = False, qos_action = None, host_based_service = False, ethertype = None, created = None, last_modified = None, description = None]
2025-10-29 13:10:14,815 - DEBUG - Response for mapping policy(s) with vn {'network': {'id': 'e5c6ccfc-0d93-4081-b520-74039fa05576', 'name': 'ctest-vn1-05240311', 'tenant_id': 'af5a12a7b91d45da97875a9ac7f0e30b', 'project_id': 'af5a12a7b91d45da97875a9ac7f0e30b', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': ['5826cccc-520a-4ba0-924c-517f34545eca'], 'fq_name': ['default-domain', 'ctest-AnalyticsTestSanityWithResource-89447487', 'ctest-vn1-05240311'], 'policys': [['default-domain', 'ctest-AnalyticsTestSanityWithResource-89447487', 'policy1']], 'subnet_ipam': [{'subnet_cidr': '40.101.173.192/26', 'ipam_fq_name': ['default-domain', 'default-project', 'default-network-ipam']}], 'port_security_enabled': True, 'description': ''}}
2025-10-29 13:10:15,034 - DEBUG - Response for mapping policy(s) with vn {'network': {'id': 'a75d0bd5-7556-4f71-acca-520abf97e0eb', 'name': 'ctest-vn2-75024386', 'tenant_id': 'af5a12a7b91d45da97875a9ac7f0e30b', 'project_id': 'af5a12a7b91d45da97875a9ac7f0e30b', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': ['11b080d3-6c83-44c0-a302-981472898d36'], 'fq_name': ['default-domain', 'ctest-AnalyticsTestSanityWithResource-89447487', 'ctest-vn2-75024386'], 'policys': [['default-domain', 'ctest-AnalyticsTestSanityWithResource-89447487', 'policy1']], 'subnet_ipam': [{'subnet_cidr': '96.224.65.0/26', 'ipam_fq_name': ['default-domain', 'default-project', 'default-network-ipam']}], 'port_security_enabled': True, 'description': ''}}
2025-10-29 13:10:15,137 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:10:15,144 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:10:15,184 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:10:15,304 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/e5c6ccfc-0d93-4081-b520-74039fa05576
2025-10-29 13:10:15,321 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/e5c6ccfc-0d93-4081-b520-74039fa05576
2025-10-29 13:10:15,406 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/7236d9d1-2e09-4da8-b4c4-edaf43b257d5
2025-10-29 13:10:15,429 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/7236d9d1-2e09-4da8-b4c4-edaf43b257d5
2025-10-29 13:10:15,441 - DEBUG - Requesting: http://10.0.0.38:8082/route-target/d9177960-7ffb-4257-bea4-1af220deb912
2025-10-29 13:10:15,453 - DEBUG - Route Targets: ['target:64512:8000004']
2025-10-29 13:10:15,453 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/e5c6ccfc-0d93-4081-b520-74039fa05576
2025-10-29 13:10:15,466 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/7236d9d1-2e09-4da8-b4c4-edaf43b257d5
2025-10-29 13:10:15,486 - INFO - Verified VN network id 15 for VN e5c6ccfc-0d93-4081-b520-74039fa05576
2025-10-29 13:10:15,486 - INFO - Verifications in API Server for VN ctest-vn1-05240311 passed
2025-10-29 13:10:15,486 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/e5c6ccfc-0d93-4081-b520-74039fa05576
2025-10-29 13:10:15,499 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/7236d9d1-2e09-4da8-b4c4-edaf43b257d5
2025-10-29 13:10:15,523 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/7236d9d1-2e09-4da8-b4c4-edaf43b257d5
2025-10-29 13:10:15,551 - DEBUG - Requesting: http://10.0.0.38:8082/route-target/d9177960-7ffb-4257-bea4-1af220deb912
2025-10-29 13:10:15,610 - DEBUG - Control-node 10.0.0.38 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '16557146463005786241', 'uuid-lslong': '13051559279031506294'}, 'enable': 'true', 'created': '2025-10-29T13:08:48', 'last-modified': '2025-10-29T13:10:14', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.838340'}
2025-10-29 13:10:15,631 - DEBUG - Route Targets: ['target:64512:8000004']
2025-10-29 13:10:15,638 - DEBUG - Control-node 10.0.0.254 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '16557146463005786241', 'uuid-lslong': '13051559279031506294'}, 'enable': 'true', 'created': '2025-10-29T13:08:48', 'last-modified': '2025-10-29T13:10:14', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.876022'}
2025-10-29 13:10:15,646 - DEBUG - Route Targets: ['target:64512:8000004']
2025-10-29 13:10:15,653 - DEBUG - Control-node 10.0.0.48 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'interests': '0', 'advertised': '0', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '16557146463005786241', 'uuid-lslong': '13051559279031506294'}, 'enable': 'true', 'created': '2025-10-29T13:08:48', 'last-modified': '2025-10-29T13:10:14', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.890732'}
2025-10-29 13:10:15,665 - DEBUG - Route Targets: ['target:64512:8000004']
2025-10-29 13:10:15,666 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-vn1-05240311 passed
2025-10-29 13:10:15,667 - DEBUG - ====Verifying policy data for ctest-vn1-05240311 in API_Server ======
2025-10-29 13:10:15,667 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:10:15,673 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:10:15,685 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:10:15,790 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/e5c6ccfc-0d93-4081-b520-74039fa05576
2025-10-29 13:10:15,804 - DEBUG - ==>Verifying data for policy with id: 58b37895-0a0a-41cf-820e-d4d4629e405f, fqn: ['default-domain', 'ctest-AnalyticsTestSanityWithResource-89447487', 'policy1']
2025-10-29 13:10:15,804 - INFO - VN ctest-vn1-05240311 Policy verification: verify_vn_policy_in_api_server, status: True
2025-10-29 13:10:15,804 - DEBUG - Verifying the vn in opserver
2025-10-29 13:10:15,804 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311 virtual network link through opserver 10.0.0.38
2025-10-29 13:10:15,804 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/virtual-networks
2025-10-29 13:10:15,817 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'href': 'http://10.0.0.38:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311?flat'}
2025-10-29 13:10:15,818 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311 virtual network link through opserver 10.0.0.254
2025-10-29 13:10:15,818 - DEBUG - Requesting: http://10.0.0.254:8081/analytics/uves/virtual-networks
2025-10-29 13:10:15,831 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'href': 'http://10.0.0.254:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311?flat'}
2025-10-29 13:10:15,832 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311 virtual network link through opserver 10.0.0.48
2025-10-29 13:10:15,832 - DEBUG - Requesting: http://10.0.0.48:8081/analytics/uves/virtual-networks
2025-10-29 13:10:15,848 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'href': 'http://10.0.0.48:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311?flat'}
2025-10-29 13:10:15,848 - INFO - Validated that VN default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311 is found in opserver
2025-10-29 13:10:15,861 - DEBUG - VRF ids for VN ctest-vn1-05240311: {'10.0.0.50': '2'}
2025-10-29 13:10:15,861 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:10:15,869 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:10:15,891 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:10:16,003 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/a75d0bd5-7556-4f71-acca-520abf97e0eb
2025-10-29 13:10:16,018 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/a75d0bd5-7556-4f71-acca-520abf97e0eb
2025-10-29 13:10:16,032 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/cac10a02-ce06-4ad8-971d-6bb900a94366
2025-10-29 13:10:16,041 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/cac10a02-ce06-4ad8-971d-6bb900a94366
2025-10-29 13:10:16,050 - DEBUG - Requesting: http://10.0.0.38:8082/route-target/b6954603-0b43-4b60-b8f7-a6260ff209a4
2025-10-29 13:10:16,057 - DEBUG - Route Targets: ['target:64512:8000006']
2025-10-29 13:10:16,058 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/a75d0bd5-7556-4f71-acca-520abf97e0eb
2025-10-29 13:10:16,070 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/cac10a02-ce06-4ad8-971d-6bb900a94366
2025-10-29 13:10:16,089 - INFO - Verified VN network id 16 for VN a75d0bd5-7556-4f71-acca-520abf97e0eb
2025-10-29 13:10:16,089 - INFO - Verifications in API Server for VN ctest-vn2-75024386 passed
2025-10-29 13:10:16,089 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/a75d0bd5-7556-4f71-acca-520abf97e0eb
2025-10-29 13:10:16,107 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/cac10a02-ce06-4ad8-971d-6bb900a94366
2025-10-29 13:10:16,117 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/cac10a02-ce06-4ad8-971d-6bb900a94366
2025-10-29 13:10:16,127 - DEBUG - Requesting: http://10.0.0.38:8082/route-target/b6954603-0b43-4b60-b8f7-a6260ff209a4
2025-10-29 13:10:16,143 - DEBUG - Control-node 10.0.0.38 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'interests': '0', 'advertised': '0', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '12059808388592586609', 'uuid-lslong': '12450854325936709867'}, 'enable': 'true', 'created': '2025-10-29T13:09:30', 'last-modified': '2025-10-29T13:10:14', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.126462'}
2025-10-29 13:10:16,151 - DEBUG - Route Targets: ['target:64512:8000006']
2025-10-29 13:10:16,159 - DEBUG - Control-node 10.0.0.254 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '12059808388592586609', 'uuid-lslong': '12450854325936709867'}, 'enable': 'true', 'created': '2025-10-29T13:09:30', 'last-modified': '2025-10-29T13:10:14', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.152140'}
2025-10-29 13:10:16,166 - DEBUG - Route Targets: ['target:64512:8000006']
2025-10-29 13:10:16,176 - DEBUG - Control-node 10.0.0.48 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'interests': '0', 'advertised': '0', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '12059808388592586609', 'uuid-lslong': '12450854325936709867'}, 'enable': 'true', 'created': '2025-10-29T13:09:30', 'last-modified': '2025-10-29T13:10:14', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.168298'}
2025-10-29 13:10:16,184 - DEBUG - Route Targets: ['target:64512:8000006']
2025-10-29 13:10:16,184 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-vn2-75024386 passed
2025-10-29 13:10:16,184 - DEBUG - ====Verifying policy data for ctest-vn2-75024386 in API_Server ======
2025-10-29 13:10:16,184 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:10:16,192 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:10:16,206 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:10:16,346 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/a75d0bd5-7556-4f71-acca-520abf97e0eb
2025-10-29 13:10:16,362 - DEBUG - ==>Verifying data for policy with id: 58b37895-0a0a-41cf-820e-d4d4629e405f, fqn: ['default-domain', 'ctest-AnalyticsTestSanityWithResource-89447487', 'policy1']
2025-10-29 13:10:16,363 - INFO - VN ctest-vn2-75024386 Policy verification: verify_vn_policy_in_api_server, status: True
2025-10-29 13:10:16,363 - DEBUG - Verifying the vn in opserver
2025-10-29 13:10:16,363 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386 virtual network link through opserver 10.0.0.38
2025-10-29 13:10:16,363 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/virtual-networks
2025-10-29 13:10:16,381 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'href': 'http://10.0.0.38:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386?flat'}
2025-10-29 13:10:16,381 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386 virtual network link through opserver 10.0.0.254
2025-10-29 13:10:16,381 - DEBUG - Requesting: http://10.0.0.254:8081/analytics/uves/virtual-networks
2025-10-29 13:10:16,395 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'href': 'http://10.0.0.254:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386?flat'}
2025-10-29 13:10:16,395 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386 virtual network link through opserver 10.0.0.48
2025-10-29 13:10:16,395 - DEBUG - Requesting: http://10.0.0.48:8081/analytics/uves/virtual-networks
2025-10-29 13:10:16,415 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'href': 'http://10.0.0.48:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386?flat'}
2025-10-29 13:10:16,415 - INFO - Validated that VN default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386 is found in opserver
2025-10-29 13:10:16,427 - DEBUG - VRF ids for VN ctest-vn2-75024386: {'10.0.0.49': '2', '10.0.0.50': '3'}
2025-10-29 13:10:16,427 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:10:16,433 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:10:16,447 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:10:16,545 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/e5c6ccfc-0d93-4081-b520-74039fa05576
2025-10-29 13:10:16,559 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/e5c6ccfc-0d93-4081-b520-74039fa05576
2025-10-29 13:10:16,571 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/7236d9d1-2e09-4da8-b4c4-edaf43b257d5
2025-10-29 13:10:16,581 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/7236d9d1-2e09-4da8-b4c4-edaf43b257d5
2025-10-29 13:10:16,592 - DEBUG - Requesting: http://10.0.0.38:8082/route-target/d9177960-7ffb-4257-bea4-1af220deb912
2025-10-29 13:10:16,600 - DEBUG - Route Targets: ['target:64512:8000004']
2025-10-29 13:10:16,601 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/e5c6ccfc-0d93-4081-b520-74039fa05576
2025-10-29 13:10:16,618 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/7236d9d1-2e09-4da8-b4c4-edaf43b257d5
2025-10-29 13:10:16,645 - INFO - Verified VN network id 15 for VN e5c6ccfc-0d93-4081-b520-74039fa05576
2025-10-29 13:10:16,645 - INFO - Verifications in API Server for VN ctest-vn1-05240311 passed
2025-10-29 13:10:16,645 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/e5c6ccfc-0d93-4081-b520-74039fa05576
2025-10-29 13:10:16,661 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/7236d9d1-2e09-4da8-b4c4-edaf43b257d5
2025-10-29 13:10:16,678 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/7236d9d1-2e09-4da8-b4c4-edaf43b257d5
2025-10-29 13:10:16,688 - DEBUG - Requesting: http://10.0.0.38:8082/route-target/d9177960-7ffb-4257-bea4-1af220deb912
2025-10-29 13:10:16,709 - DEBUG - Control-node 10.0.0.38 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '16557146463005786241', 'uuid-lslong': '13051559279031506294'}, 'enable': 'true', 'created': '2025-10-29T13:08:48', 'last-modified': '2025-10-29T13:10:14', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.938859'}
2025-10-29 13:10:16,717 - DEBUG - Route Targets: ['target:64512:8000004']
2025-10-29 13:10:16,723 - DEBUG - Control-node 10.0.0.254 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '16557146463005786241', 'uuid-lslong': '13051559279031506294'}, 'enable': 'true', 'created': '2025-10-29T13:08:48', 'last-modified': '2025-10-29T13:10:14', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.961597'}
2025-10-29 13:10:16,730 - DEBUG - Route Targets: ['target:64512:8000004']
2025-10-29 13:10:16,736 - DEBUG - Control-node 10.0.0.48 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'interests': '0', 'advertised': '0', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '16557146463005786241', 'uuid-lslong': '13051559279031506294'}, 'enable': 'true', 'created': '2025-10-29T13:08:48', 'last-modified': '2025-10-29T13:10:14', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.974687'}
2025-10-29 13:10:16,745 - DEBUG - Route Targets: ['target:64512:8000004']
2025-10-29 13:10:16,745 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-vn1-05240311 passed
2025-10-29 13:10:16,745 - DEBUG - ====Verifying policy data for ctest-vn1-05240311 in API_Server ======
2025-10-29 13:10:16,745 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:10:16,752 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:10:16,765 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:10:16,861 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/e5c6ccfc-0d93-4081-b520-74039fa05576
2025-10-29 13:10:16,874 - DEBUG - ==>Verifying data for policy with id: 58b37895-0a0a-41cf-820e-d4d4629e405f, fqn: ['default-domain', 'ctest-AnalyticsTestSanityWithResource-89447487', 'policy1']
2025-10-29 13:10:16,874 - INFO - VN ctest-vn1-05240311 Policy verification: verify_vn_policy_in_api_server, status: True
2025-10-29 13:10:16,875 - DEBUG - Verifying the vn in opserver
2025-10-29 13:10:16,875 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311 virtual network link through opserver 10.0.0.38
2025-10-29 13:10:16,875 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/virtual-networks
2025-10-29 13:10:16,892 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'href': 'http://10.0.0.38:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311?flat'}
2025-10-29 13:10:16,892 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311 virtual network link through opserver 10.0.0.254
2025-10-29 13:10:16,892 - DEBUG - Requesting: http://10.0.0.254:8081/analytics/uves/virtual-networks
2025-10-29 13:10:16,906 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'href': 'http://10.0.0.254:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311?flat'}
2025-10-29 13:10:16,906 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311 virtual network link through opserver 10.0.0.48
2025-10-29 13:10:16,906 - DEBUG - Requesting: http://10.0.0.48:8081/analytics/uves/virtual-networks
2025-10-29 13:10:16,923 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'href': 'http://10.0.0.48:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311?flat'}
2025-10-29 13:10:16,923 - INFO - Validated that VN default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311 is found in opserver
2025-10-29 13:10:16,935 - DEBUG - VRF ids for VN ctest-vn1-05240311: {'10.0.0.50': '2'}
2025-10-29 13:10:16,935 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:10:16,942 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:10:16,955 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:10:17,054 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/a75d0bd5-7556-4f71-acca-520abf97e0eb
2025-10-29 13:10:17,072 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/a75d0bd5-7556-4f71-acca-520abf97e0eb
2025-10-29 13:10:17,085 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/cac10a02-ce06-4ad8-971d-6bb900a94366
2025-10-29 13:10:17,097 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/cac10a02-ce06-4ad8-971d-6bb900a94366
2025-10-29 13:10:17,106 - DEBUG - Requesting: http://10.0.0.38:8082/route-target/b6954603-0b43-4b60-b8f7-a6260ff209a4
2025-10-29 13:10:17,114 - DEBUG - Route Targets: ['target:64512:8000006']
2025-10-29 13:10:17,114 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/a75d0bd5-7556-4f71-acca-520abf97e0eb
2025-10-29 13:10:17,126 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/cac10a02-ce06-4ad8-971d-6bb900a94366
2025-10-29 13:10:17,146 - INFO - Verified VN network id 16 for VN a75d0bd5-7556-4f71-acca-520abf97e0eb
2025-10-29 13:10:17,146 - INFO - Verifications in API Server for VN ctest-vn2-75024386 passed
2025-10-29 13:10:17,146 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/a75d0bd5-7556-4f71-acca-520abf97e0eb
2025-10-29 13:10:17,160 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/cac10a02-ce06-4ad8-971d-6bb900a94366
2025-10-29 13:10:17,169 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/cac10a02-ce06-4ad8-971d-6bb900a94366
2025-10-29 13:10:17,179 - DEBUG - Requesting: http://10.0.0.38:8082/route-target/b6954603-0b43-4b60-b8f7-a6260ff209a4
2025-10-29 13:10:17,195 - DEBUG - Control-node 10.0.0.38 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'interests': '0', 'advertised': '0', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '12059808388592586609', 'uuid-lslong': '12450854325936709867'}, 'enable': 'true', 'created': '2025-10-29T13:09:30', 'last-modified': '2025-10-29T13:10:14', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:02.179770'}
2025-10-29 13:10:17,201 - DEBUG - Route Targets: ['target:64512:8000006']
2025-10-29 13:10:17,207 - DEBUG - Control-node 10.0.0.254 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '12059808388592586609', 'uuid-lslong': '12450854325936709867'}, 'enable': 'true', 'created': '2025-10-29T13:09:30', 'last-modified': '2025-10-29T13:10:14', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:02.200668'}
2025-10-29 13:10:17,214 - DEBUG - Route Targets: ['target:64512:8000006']
2025-10-29 13:10:17,223 - DEBUG - Control-node 10.0.0.48 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'interests': '0', 'advertised': '0', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '12059808388592586609', 'uuid-lslong': '12450854325936709867'}, 'enable': 'true', 'created': '2025-10-29T13:09:30', 'last-modified': '2025-10-29T13:10:14', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:02.213874'}
2025-10-29 13:10:17,232 - DEBUG - Route Targets: ['target:64512:8000006']
2025-10-29 13:10:17,232 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-vn2-75024386 passed
2025-10-29 13:10:17,232 - DEBUG - ====Verifying policy data for ctest-vn2-75024386 in API_Server ======
2025-10-29 13:10:17,232 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:10:17,240 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:10:17,254 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:10:17,350 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/a75d0bd5-7556-4f71-acca-520abf97e0eb
2025-10-29 13:10:17,364 - DEBUG - ==>Verifying data for policy with id: 58b37895-0a0a-41cf-820e-d4d4629e405f, fqn: ['default-domain', 'ctest-AnalyticsTestSanityWithResource-89447487', 'policy1']
2025-10-29 13:10:17,364 - INFO - VN ctest-vn2-75024386 Policy verification: verify_vn_policy_in_api_server, status: True
2025-10-29 13:10:17,364 - DEBUG - Verifying the vn in opserver
2025-10-29 13:10:17,365 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386 virtual network link through opserver 10.0.0.38
2025-10-29 13:10:17,365 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/virtual-networks
2025-10-29 13:10:17,381 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'href': 'http://10.0.0.38:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386?flat'}
2025-10-29 13:10:17,381 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386 virtual network link through opserver 10.0.0.254
2025-10-29 13:10:17,381 - DEBUG - Requesting: http://10.0.0.254:8081/analytics/uves/virtual-networks
2025-10-29 13:10:17,397 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'href': 'http://10.0.0.254:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386?flat'}
2025-10-29 13:10:17,397 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386 virtual network link through opserver 10.0.0.48
2025-10-29 13:10:17,397 - DEBUG - Requesting: http://10.0.0.48:8081/analytics/uves/virtual-networks
2025-10-29 13:10:17,410 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'href': 'http://10.0.0.48:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386?flat'}
2025-10-29 13:10:17,410 - INFO - Validated that VN default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386 is found in opserver
2025-10-29 13:10:17,423 - DEBUG - VRF ids for VN ctest-vn2-75024386: {'10.0.0.49': '2', '10.0.0.50': '3'}
2025-10-29 13:10:17,423 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:10:17,429 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:10:17,443 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:10:17,533 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/ca642a81-efdf-473c-ab45-d7bd77cf0aa9
2025-10-29 13:10:17,548 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/ca642a81-efdf-473c-ab45-d7bd77cf0aa9
2025-10-29 13:10:17,559 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/3475effc-7b8a-4996-8550-0e7a9e5e7c31
2025-10-29 13:10:17,569 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/3475effc-7b8a-4996-8550-0e7a9e5e7c31
2025-10-29 13:10:17,577 - DEBUG - Requesting: http://10.0.0.38:8082/route-target/19f25b5e-eabf-41e5-a22c-6a6067aa7d98
2025-10-29 13:10:17,585 - DEBUG - Route Targets: ['target:64512:8000007']
2025-10-29 13:10:17,585 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/ca642a81-efdf-473c-ab45-d7bd77cf0aa9
2025-10-29 13:10:17,596 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/3475effc-7b8a-4996-8550-0e7a9e5e7c31
2025-10-29 13:10:17,615 - INFO - Verified VN network id 17 for VN ca642a81-efdf-473c-ab45-d7bd77cf0aa9
2025-10-29 13:10:17,615 - INFO - Verifications in API Server for VN ctest-fip_vn-09274405 passed
2025-10-29 13:10:17,615 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/ca642a81-efdf-473c-ab45-d7bd77cf0aa9
2025-10-29 13:10:17,632 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/3475effc-7b8a-4996-8550-0e7a9e5e7c31
2025-10-29 13:10:17,641 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/3475effc-7b8a-4996-8550-0e7a9e5e7c31
2025-10-29 13:10:17,650 - DEBUG - Requesting: http://10.0.0.38:8082/route-target/19f25b5e-eabf-41e5-a22c-6a6067aa7d98
2025-10-29 13:10:17,666 - DEBUG - Control-node 10.0.0.38 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405', 'interests': '0', 'advertised': '0', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '14583828230896043836', 'uuid-lslong': '12341507562637560489'}, 'enable': 'true', 'created': '2025-10-29T13:09:31', 'last-modified': '2025-10-29T13:09:31', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:45.930310'}
2025-10-29 13:10:17,673 - DEBUG - Route Targets: ['target:64512:8000007']
2025-10-29 13:10:17,680 - DEBUG - Control-node 10.0.0.254 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '14583828230896043836', 'uuid-lslong': '12341507562637560489'}, 'enable': 'true', 'created': '2025-10-29T13:09:31', 'last-modified': '2025-10-29T13:09:31', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:45.945944'}
2025-10-29 13:10:17,687 - DEBUG - Route Targets: ['target:64512:8000007']
2025-10-29 13:10:17,693 - DEBUG - Control-node 10.0.0.48 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-AnalyticsTestSanityWithResource-89447487', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '14583828230896043836', 'uuid-lslong': '12341507562637560489'}, 'enable': 'true', 'created': '2025-10-29T13:09:31', 'last-modified': '2025-10-29T13:09:31', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:45.959269'}
2025-10-29 13:10:17,700 - DEBUG - Route Targets: ['target:64512:8000007']
2025-10-29 13:10:17,701 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-fip_vn-09274405 passed
2025-10-29 13:10:17,701 - DEBUG - ====Verifying policy data for ctest-fip_vn-09274405 in API_Server ======
2025-10-29 13:10:17,701 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:10:17,707 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:10:17,720 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:10:17,821 - DEBUG - Requesting: http://10.0.0.38:8082/virtual-network/ca642a81-efdf-473c-ab45-d7bd77cf0aa9
2025-10-29 13:10:17,835 - DEBUG - =>VN ctest-fip_vn-09274405 has no policy to be verified
2025-10-29 13:10:17,835 - DEBUG - Verifying the vn in opserver
2025-10-29 13:10:17,835 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405 virtual network link through opserver 10.0.0.38
2025-10-29 13:10:17,835 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/virtual-networks
2025-10-29 13:10:17,852 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405', 'href': 'http://10.0.0.38:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405?flat'}
2025-10-29 13:10:17,852 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405 virtual network link through opserver 10.0.0.254
2025-10-29 13:10:17,852 - DEBUG - Requesting: http://10.0.0.254:8081/analytics/uves/virtual-networks
2025-10-29 13:10:17,869 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405', 'href': 'http://10.0.0.254:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405?flat'}
2025-10-29 13:10:17,869 - DEBUG - Verifying the default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405 virtual network link through opserver 10.0.0.48
2025-10-29 13:10:17,869 - DEBUG - Requesting: http://10.0.0.48:8081/analytics/uves/virtual-networks
2025-10-29 13:10:17,886 - DEBUG - vn link and name as {'name': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405', 'href': 'http://10.0.0.48:8081/analytics/uves/virtual-network/default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405?flat'}
2025-10-29 13:10:17,887 - INFO - Validated that VN default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405 is found in opserver
2025-10-29 13:10:17,901 - DEBUG - VRF ids for VN ctest-fip_vn-09274405: {'10.0.0.49': '3'}
2025-10-29 13:10:17,901 - INFO - start time= 1761743417901648
2025-10-29 13:10:17,901 - DEBUG - Running remote_cmd, Cmd : ping -s 56 -c 3 -W 1 96.224.65.3, host_string: cirros@169.254.0.3, password: gocubsgogateway: ubuntu@10.0.0.50, gateway password: c0ntrail123
2025-10-29 13:10:17,901 - DEBUG - ping -s 56 -c 3 -W 1 96.224.65.3
2025-10-29 13:10:21,836 - DEBUG - PING 96.224.65.3 (96.224.65.3): 56 data bytes
64 bytes from 96.224.65.3: seq=0 ttl=63 time=7.627 ms
64 bytes from 96.224.65.3: seq=1 ttl=63 time=2.054 ms
64 bytes from 96.224.65.3: seq=2 ttl=63 time=1.791 ms
--- 96.224.65.3 ping statistics ---
3 packets transmitted, 3 packets received, 0% packet loss
round-trip min/avg/max = 1.791/3.824/7.627 ms
2025-10-29 13:10:21,836 - INFO - Ping to IP 96.224.65.3 from VM ctest-vn1_vm1-04256296 passed
2025-10-29 13:10:31,837 - INFO - Verify session samples and teardown pkts
2025-10-29 13:10:31,838 - INFO - Verifying SessionSeriesTable through opserver 10.0.0.38
2025-10-29 13:10:31,842 - DEBUG - Posting: http://10.0.0.38:8081/analytics/query, payload {'table': 'SessionSeriesTable', 'start_time': 1761743417901648, 'end_time': 1761743431842443, 'select_fields': ['T'], 'where': [[{'name': 'vn', 'value': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'op': 1, 'value2': None}, {'name': 'remote_vn', 'value': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'op': 1, 'value2': None}, {'name': 'protocol', 'value': '1', 'op': 1, 'value2': None}]], 'session_type': 'client'}
2025-10-29 13:10:32,865 - DEBUG - [{'T': 1761743420285334}, {'T': 1761743421285490}, {'T': 1761743422285571}]
2025-10-29 13:10:32,865 - DEBUG - Posting: http://10.0.0.38:8081/analytics/query, payload {'table': 'SessionSeriesTable', 'start_time': 1761743417901648, 'end_time': 1761743432865192, 'select_fields': ['T'], 'where': [[{'name': 'vn', 'value': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'op': 1, 'value2': None}, {'name': 'remote_vn', 'value': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'op': 1, 'value2': None}, {'name': 'protocol', 'value': '1', 'op': 1, 'value2': None}]], 'session_type': 'server'}
2025-10-29 13:10:33,890 - DEBUG - [{'T': 1761743419990461}, {'T': 1761743420990599}, {'T': 1761743421990727}]
2025-10-29 13:10:33,890 - DEBUG - Posting: http://10.0.0.38:8081/analytics/query, payload {'table': 'SessionSeriesTable', 'start_time': 1761743417901648, 'end_time': 1761743433890604, 'select_fields': ['vn', 'remote_vn', 'sample_count'], 'where': [[{'name': 'vn', 'value': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'op': 1, 'value2': None}, {'name': 'remote_vn', 'value': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'op': 1, 'value2': None}, {'name': 'protocol', 'value': '1', 'op': 1, 'value2': None}]], 'session_type': 'client'}
2025-10-29 13:10:34,917 - DEBUG - [{'remote_vn': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'vn': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'sample_count': 3}]
2025-10-29 13:10:34,917 - INFO - wait for the flows to get expire
2025-10-29 13:13:54,917 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/generator/an-jenkins-deploy-platform-ansible-os-4521-2:Compute:contrail-vrouter-agent:0?flat
2025-10-29 13:13:54,961 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/vrouter/an-jenkins-deploy-platform-ansible-os-4521-2?flat
2025-10-29 13:13:55,003 - DEBUG - Posting: http://10.0.0.38:8081/analytics/query, payload {'table': 'SessionRecordTable', 'start_time': 1761743417901648, 'end_time': 1761743635003308, 'select_fields': ['vn', 'remote_vn', 'forward_teardown_pkts', 'reverse_teardown_pkts'], 'where': [[{'name': 'vn', 'value': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'op': 1, 'value2': None}, {'name': 'remote_vn', 'value': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'op': 1, 'value2': None}, {'name': 'protocol', 'value': '1', 'op': 1, 'value2': None}]], 'session_type': 'client'}
2025-10-29 13:13:56,090 - DEBUG - [{'forward_flow_uuid': '46eef1fb-0c38-4525-b0d5-97ef2dd56113', 'remote_vn': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'reverse_flow_uuid': 'bc4f3826-ea92-4949-ac81-c6bb2aa7f344', 'vn': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'forward_teardown_pkts': 3, 'reverse_teardown_pkts': 3}]
2025-10-29 13:13:56,090 - DEBUG - Posting: http://10.0.0.38:8081/analytics/query, payload {'table': 'SessionSeriesTable', 'start_time': 1761743417901648, 'end_time': 1761743636090866, 'select_fields': ['vn', 'remote_vn', 'sample_count'], 'where': [[{'name': 'vn', 'value': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'op': 1, 'value2': None}, {'name': 'remote_vn', 'value': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'op': 1, 'value2': None}, {'name': 'protocol', 'value': '1', 'op': 1, 'value2': None}]], 'session_type': 'client'}
2025-10-29 13:13:57,122 - DEBUG - Posting: http://10.0.0.38:8081/analytics/query, payload {'table': 'SessionSeriesTable', 'start_time': 1761743417901648, 'end_time': 1761743637122917, 'select_fields': ['vn', 'remote_vn', 'sample_count'], 'where': [[{'name': 'vn', 'value': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'op': 1, 'value2': None}, {'name': 'remote_vn', 'value': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'op': 1, 'value2': None}, {'name': 'protocol', 'value': '1', 'op': 1, 'value2': None}]], 'session_type': 'server'}
2025-10-29 13:13:58,158 - DEBUG - [{'remote_vn': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311', 'vn': 'default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386', 'sample_count': 4}]
2025-10-29 13:13:58,670 - INFO - Deleted policy policy1
2025-10-29 13:13:58,788 - INFO - Setting flow export rate: None
2025-10-29 13:14:00,078 - DEBUG - Skipping xmpp flap check
2025-10-29 13:14:00,079 - INFO - END TEST : test_verify_session_sampling_teardown : PASSED[0:03:48]
2025-10-29 13:14:00,079 - INFO - --------------------------------------------------------------------------------
2025-10-29 13:14:00,081 - INFO - Deleting VM mltf_vm
2025-10-29 13:14:00,159 - INFO - Deleting VM ctest-fvn_vm1-64911004
2025-10-29 13:14:00,241 - INFO - Deleting VM ctest-vn2_vm2-64247489
2025-10-29 13:14:00,337 - INFO - Deleting VN ctest-fip_vn-09274405
2025-10-29 13:14:00,391 - DEBUG - VN ca642a81-efdf-473c-ab45-d7bd77cf0aa9 still in use: Unable to complete operation on network ca642a81-efdf-473c-ab45-d7bd77cf0aa9. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-61074a1c-fc4e-415f-a8ae-d1066193cb30']
2025-10-29 13:14:00,391 - WARNING - Deleting VN ctest-fip_vn-09274405 failed..Will retry
2025-10-29 13:14:02,578 - DEBUG - Response for deleting network ()
2025-10-29 13:14:02,578 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/3475effc-7b8a-4996-8550-0e7a9e5e7c31
2025-10-29 13:14:02,624 - DEBUG - Response Code: 404
2025-10-29 13:14:02,624 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:14:02,631 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:14:02,642 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:14:02,753 - INFO - Validated that VN ctest-fip_vn-09274405 is not found in API Server
2025-10-29 13:14:02,766 - DEBUG - VN ctest-fip_vn-09274405 is not present in Agent 10.0.0.49
2025-10-29 13:14:02,780 - DEBUG - VN ctest-fip_vn-09274405 is not present in Agent 10.0.0.50
2025-10-29 13:14:02,780 - INFO - Validated that VN ctest-fip_vn-09274405 is not in any agent
2025-10-29 13:14:02,788 - DEBUG - VRF 3 is not seen in agent 10.0.0.49
2025-10-29 13:14:02,798 - DEBUG - Vrouter 10.0.0.49 does not have vrf 3 for VN ctest-fip_vn-09274405
2025-10-29 13:14:02,798 - INFO - Validated that all vrouters do not have the route table for VN default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-fip_vn-09274405
2025-10-29 13:14:02,823 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-fip_vn-09274405 info
2025-10-29 13:14:02,824 - INFO - Deleting VN ctest-vn2-75024386
2025-10-29 13:14:03,021 - DEBUG - Response for deleting network ()
2025-10-29 13:14:03,021 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/cac10a02-ce06-4ad8-971d-6bb900a94366
2025-10-29 13:14:03,027 - DEBUG - Response Code: 404
2025-10-29 13:14:03,027 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:14:03,033 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:14:03,045 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:14:03,157 - INFO - Validated that VN ctest-vn2-75024386 is not found in API Server
2025-10-29 13:14:03,167 - DEBUG - VN ctest-vn2-75024386 is not present in Agent 10.0.0.49
2025-10-29 13:14:03,178 - DEBUG - VN ctest-vn2-75024386 is not present in Agent 10.0.0.50
2025-10-29 13:14:03,178 - INFO - Validated that VN ctest-vn2-75024386 is not in any agent
2025-10-29 13:14:03,186 - DEBUG - VRF 2 is not seen in agent 10.0.0.49
2025-10-29 13:14:03,192 - DEBUG - Vrouter 10.0.0.49 does not have vrf 2 for VN ctest-vn2-75024386
2025-10-29 13:14:03,198 - DEBUG - VRF 3 is not seen in agent 10.0.0.50
2025-10-29 13:14:03,204 - DEBUG - Vrouter 10.0.0.50 does not have vrf 3 for VN ctest-vn2-75024386
2025-10-29 13:14:03,204 - INFO - Validated that all vrouters do not have the route table for VN default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn2-75024386
2025-10-29 13:14:03,231 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-vn2-75024386 info
2025-10-29 13:14:03,232 - INFO - Deleting VM ctest-vn1_vm2-17929952
2025-10-29 13:14:03,322 - INFO - Deleting VM ctest-vn1_vm1-04256296
2025-10-29 13:14:03,415 - INFO - Deleting VN ctest-vn1-05240311
2025-10-29 13:14:03,476 - DEBUG - VN e5c6ccfc-0d93-4081-b520-74039fa05576 still in use: Unable to complete operation on network e5c6ccfc-0d93-4081-b520-74039fa05576. There are one or more ports still in use on the network.
Neutron server returns request_ids: ['req-0aa9207d-907d-49b6-aeb0-29862f4285c3']
2025-10-29 13:14:03,476 - WARNING - Deleting VN ctest-vn1-05240311 failed..Will retry
2025-10-29 13:14:05,676 - DEBUG - Response for deleting network ()
2025-10-29 13:14:05,677 - DEBUG - Requesting: http://10.0.0.38:8082/routing-instance/7236d9d1-2e09-4da8-b4c4-edaf43b257d5
2025-10-29 13:14:05,686 - DEBUG - Response Code: 404
2025-10-29 13:14:05,686 - DEBUG - Requesting: http://10.0.0.38:8082/domains
2025-10-29 13:14:05,695 - DEBUG - Requesting: http://10.0.0.38:8082/domain/fd9d3a52-0780-4060-8425-e3c883ec81fc
2025-10-29 13:14:05,711 - DEBUG - Requesting: http://10.0.0.38:8082/project/af5a12a7-b91d-45da-9787-5a9ac7f0e30b
2025-10-29 13:14:05,805 - INFO - Validated that VN ctest-vn1-05240311 is not found in API Server
2025-10-29 13:14:05,816 - DEBUG - VN ctest-vn1-05240311 is not present in Agent 10.0.0.49
2025-10-29 13:14:05,826 - DEBUG - VN ctest-vn1-05240311 is not present in Agent 10.0.0.50
2025-10-29 13:14:05,826 - INFO - Validated that VN ctest-vn1-05240311 is not in any agent
2025-10-29 13:14:05,832 - DEBUG - VRF 2 is not seen in agent 10.0.0.50
2025-10-29 13:14:05,838 - DEBUG - Vrouter 10.0.0.50 does not have vrf 2 for VN ctest-vn1-05240311
2025-10-29 13:14:05,838 - INFO - Validated that all vrouters do not have the route table for VN default-domain:ctest-AnalyticsTestSanityWithResource-89447487:ctest-vn1-05240311
2025-10-29 13:14:05,860 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-vn1-05240311 info
2025-10-29 13:14:06,706 - INFO - Deleted project: ctest-AnalyticsTestSanityWithResource-89447487, ID : af5a12a7-b91d-45da-9787-5a9ac7f0e30b