2025-08-11 02:36:48,994 - INFO - Domain Default found not creating
2025-08-11 02:36:49,131 - INFO - Project ctest-TestPolicyAcl-44915902 not found, creating it
2025-08-11 02:36:49,590 - INFO - Created Project:ctest-TestPolicyAcl-44915902, ID : be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:36:50,975 - INFO - ================================================================================
2025-08-11 02:36:50,975 - INFO - STARTING TEST : test_policy_cidr_src_cidr_dst_any
2025-08-11 02:36:50,975 - INFO - TEST DESCRIPTION : Test cases to test policy CIDR
2025-08-11 02:36:52,226 - DEBUG - Nothing to compare xmpp stats {'10.0.0.57': {'10.20.0.18': '0', '10.20.0.129': '0'}, '10.0.0.65': {'10.20.0.129': '0', '10.20.0.25': '0'}} with
2025-08-11 02:36:52,226 - INFO - Initial checks done. Running the testcase now
2025-08-11 02:36:52,226 - INFO -
2025-08-11 02:36:53,523 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:36:53,813 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:36:53,843 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:36:53,862 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:36:53,968 - DEBUG - Requesting: http://10.0.0.23:8082/network-ipam/7a700668-63d0-4270-9942-bfa15da2581e
2025-08-11 02:36:53,976 - INFO - Verifications in API Server for IPAM: ipam1 passed
2025-08-11 02:36:53,982 - DEBUG - Control-node 10.0.0.23 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam1', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '8822558715439759984', 'uuid-lslong': '11043599936047437854'}, 'enable': 'true', 'created': '2025-08-11T02:36:52', 'last-modified': '2025-08-11T02:36:52', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.160493'}
2025-08-11 02:36:53,988 - DEBUG - Control-node 10.0.0.38 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam1', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '8822558715439759984', 'uuid-lslong': '11043599936047437854'}, 'enable': 'true', 'created': '2025-08-11T02:36:52', 'last-modified': '2025-08-11T02:36:52', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.169387'}
2025-08-11 02:36:53,995 - DEBUG - Control-node 10.0.0.141 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam1', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '8822558715439759984', 'uuid-lslong': '11043599936047437854'}, 'enable': 'true', 'created': '2025-08-11T02:36:52', 'last-modified': '2025-08-11T02:36:52', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.173990'}
2025-08-11 02:36:53,996 - INFO - Verifications in Control node for IPAM: ipam1 passed
2025-08-11 02:36:53,996 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:36:54,002 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:36:54,013 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:36:54,106 - DEBUG - Requesting: http://10.0.0.23:8082/network-ipam/cddc7c7b-a3bd-42a1-8ce9-e50bff8349bf
2025-08-11 02:36:54,116 - INFO - Verifications in API Server for IPAM: ipam2 passed
2025-08-11 02:36:54,124 - DEBUG - Control-node 10.0.0.23 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam2', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '14833868143121482401', 'uuid-lslong': '10153898674577689023'}, 'enable': 'true', 'created': '2025-08-11T02:36:52', 'last-modified': '2025-08-11T02:36:53', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.973593'}
2025-08-11 02:36:54,131 - DEBUG - Control-node 10.0.0.38 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam2', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '14833868143121482401', 'uuid-lslong': '10153898674577689023'}, 'enable': 'true', 'created': '2025-08-11T02:36:52', 'last-modified': '2025-08-11T02:36:53', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.981687'}
2025-08-11 02:36:54,137 - DEBUG - Control-node 10.0.0.141 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam2', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '14833868143121482401', 'uuid-lslong': '10153898674577689023'}, 'enable': 'true', 'created': '2025-08-11T02:36:52', 'last-modified': '2025-08-11T02:36:53', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.987274'}
2025-08-11 02:36:54,137 - INFO - Verifications in Control node for IPAM: ipam2 passed
2025-08-11 02:36:54,137 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:36:54,144 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:36:54,158 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:36:54,254 - DEBUG - Requesting: http://10.0.0.23:8082/network-ipam/126afbeb-5a9b-4153-9eb2-bc2850f7c67b
2025-08-11 02:36:54,262 - INFO - Verifications in API Server for IPAM: ipam3 passed
2025-08-11 02:36:54,269 - DEBUG - Control-node 10.0.0.23 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam3', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '1327150028470042963', 'uuid-lslong': '11435409285190239867'}, 'enable': 'true', 'created': '2025-08-11T02:36:53', 'last-modified': '2025-08-11T02:36:53', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.779196'}
2025-08-11 02:36:54,274 - DEBUG - Control-node 10.0.0.38 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam3', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '1327150028470042963', 'uuid-lslong': '11435409285190239867'}, 'enable': 'true', 'created': '2025-08-11T02:36:53', 'last-modified': '2025-08-11T02:36:53', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.786421'}
2025-08-11 02:36:54,280 - DEBUG - Control-node 10.0.0.141 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam3', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '1327150028470042963', 'uuid-lslong': '11435409285190239867'}, 'enable': 'true', 'created': '2025-08-11T02:36:53', 'last-modified': '2025-08-11T02:36:53', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.790975'}
2025-08-11 02:36:54,280 - INFO - Verifications in Control node for IPAM: ipam3 passed
2025-08-11 02:36:54,546 - DEBUG - Response for create_network : {'network': {'id': '6c551eef-a5cd-46d7-9323-e514a228178e', 'name': 'ctest-VN1-64990319', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-VN1-64990319'], 'port_security_enabled': True, 'description': ''}}
2025-08-11 02:36:54,795 - DEBUG - Response for create_subnet : {'subnet': {'id': 'b63b8f4f-c243-46cb-9d1b-c0b678607ca9', 'name': '', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'network_id': '6c551eef-a5cd-46d7-9323-e514a228178e', 'ip_version': 4, 'cidr': '12.157.137.0/26', 'allocation_pools': [{'start': '12.157.137.2', 'end': '12.157.137.62'}], 'gateway_ip': '12.157.137.1', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '12.157.137.2', 'tags': [], 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe'}}
2025-08-11 02:36:54,816 - INFO - Created VN ctest-VN1-64990319
2025-08-11 02:36:54,827 - DEBUG - VN ctest-VN1-64990319 UUID is 6c551eef-a5cd-46d7-9323-e514a228178e
2025-08-11 02:36:54,967 - DEBUG - Fetched VN: default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319(6c551eef-a5cd-46d7-9323-e514a228178e) with subnets ['12.157.137.0/26']
2025-08-11 02:36:55,284 - DEBUG - Response for create_network : {'network': {'id': '5ddf9d75-1fec-4981-813f-8dbd0d9b782a', 'name': 'ctest-VN2-43822279', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-VN2-43822279'], 'port_security_enabled': True, 'description': ''}}
2025-08-11 02:36:55,515 - DEBUG - Response for create_subnet : {'subnet': {'id': 'dbff6640-9a5c-4fbb-9acf-4334edd0a8a9', 'name': '', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'network_id': '5ddf9d75-1fec-4981-813f-8dbd0d9b782a', 'ip_version': 4, 'cidr': '103.49.205.0/26', 'allocation_pools': [{'start': '103.49.205.2', 'end': '103.49.205.62'}], 'gateway_ip': '103.49.205.1', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '103.49.205.2', 'tags': [], 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe'}}
2025-08-11 02:36:55,537 - INFO - Created VN ctest-VN2-43822279
2025-08-11 02:36:55,554 - DEBUG - VN ctest-VN2-43822279 UUID is 5ddf9d75-1fec-4981-813f-8dbd0d9b782a
2025-08-11 02:36:56,057 - DEBUG - Response for create_network : {'network': {'id': 'bfa027b5-81b0-471a-b961-64cbcfa4d363', 'name': 'ctest-VN3-77129969', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-VN3-77129969'], 'port_security_enabled': True, 'description': ''}}
2025-08-11 02:36:56,378 - DEBUG - Response for create_subnet : {'subnet': {'id': '359a7a38-f9c1-46c6-a5c9-fe4b35fb2d37', 'name': '', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'network_id': 'bfa027b5-81b0-471a-b961-64cbcfa4d363', 'ip_version': 4, 'cidr': '151.236.227.128/26', 'allocation_pools': [{'start': '151.236.227.130', 'end': '151.236.227.190'}], 'gateway_ip': '151.236.227.129', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '151.236.227.130', 'tags': [], 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe'}}
2025-08-11 02:36:56,406 - INFO - Created VN ctest-VN3-77129969
2025-08-11 02:36:56,423 - DEBUG - VN ctest-VN3-77129969 UUID is bfa027b5-81b0-471a-b961-64cbcfa4d363
2025-08-11 02:36:56,501 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:36:56,508 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:36:56,521 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:36:56,612 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/6c551eef-a5cd-46d7-9323-e514a228178e
2025-08-11 02:36:56,629 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/6c551eef-a5cd-46d7-9323-e514a228178e
2025-08-11 02:36:56,640 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/27d64c97-e5a8-4308-a9c7-302a0fd06bb9
2025-08-11 02:36:56,651 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/27d64c97-e5a8-4308-a9c7-302a0fd06bb9
2025-08-11 02:36:56,658 - DEBUG - Requesting: http://10.0.0.23:8082/route-target/61e9428d-d619-4a97-9499-2144caddb2d8
2025-08-11 02:36:56,665 - DEBUG - Route Targets: ['target:64512:8000005']
2025-08-11 02:36:56,665 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/6c551eef-a5cd-46d7-9323-e514a228178e
2025-08-11 02:36:56,676 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/27d64c97-e5a8-4308-a9c7-302a0fd06bb9
2025-08-11 02:36:56,695 - INFO - Verified VN network id 12 for VN 6c551eef-a5cd-46d7-9323-e514a228178e
2025-08-11 02:36:56,695 - INFO - Verifications in API Server for VN ctest-VN1-64990319 passed
2025-08-11 02:36:56,695 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/6c551eef-a5cd-46d7-9323-e514a228178e
2025-08-11 02:36:56,703 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/27d64c97-e5a8-4308-a9c7-302a0fd06bb9
2025-08-11 02:36:56,710 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/27d64c97-e5a8-4308-a9c7-302a0fd06bb9
2025-08-11 02:36:56,717 - DEBUG - Requesting: http://10.0.0.23:8082/route-target/61e9428d-d619-4a97-9499-2144caddb2d8
2025-08-11 02:36:56,729 - DEBUG - Control-node 10.0.0.23 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '7806179543744333527', 'uuid-lslong': '10602569824542922638'}, 'enable': 'true', 'created': '2025-08-11T02:36:54', 'last-modified': '2025-08-11T02:36:54', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.975269'}
2025-08-11 02:36:56,736 - DEBUG - Route Targets: ['target:64512:8000005']
2025-08-11 02:36:56,742 - DEBUG - Control-node 10.0.0.38 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '7806179543744333527', 'uuid-lslong': '10602569824542922638'}, 'enable': 'true', 'created': '2025-08-11T02:36:54', 'last-modified': '2025-08-11T02:36:54', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.987801'}
2025-08-11 02:36:56,749 - DEBUG - Route Targets: ['target:64512:8000005']
2025-08-11 02:36:56,754 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '7806179543744333527', 'uuid-lslong': '10602569824542922638'}, 'enable': 'true', 'created': '2025-08-11T02:36:54', 'last-modified': '2025-08-11T02:36:54', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.999711'}
2025-08-11 02:36:56,760 - DEBUG - Route Targets: ['target:64512:8000005']
2025-08-11 02:36:56,760 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-VN1-64990319 passed
2025-08-11 02:36:56,760 - DEBUG - ====Verifying policy data for ctest-VN1-64990319 in API_Server ======
2025-08-11 02:36:56,760 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:36:56,766 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:36:56,777 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:36:56,869 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/6c551eef-a5cd-46d7-9323-e514a228178e
2025-08-11 02:36:56,878 - DEBUG - =>VN ctest-VN1-64990319 has no policy to be verified
2025-08-11 02:36:56,878 - DEBUG - Verifying the vn in opserver
2025-08-11 02:36:56,878 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319 virtual network link through opserver 10.0.0.23
2025-08-11 02:36:56,878 - DEBUG - Requesting: http://10.0.0.23:8081/analytics/uves/virtual-networks
2025-08-11 02:36:57,165 - DEBUG - Requesting: http://10.0.0.23:8081/analytics/uves/virtual-networks
2025-08-11 02:36:57,213 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319', 'href': 'http://10.0.0.23:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319?flat'}
2025-08-11 02:36:57,213 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319 virtual network link through opserver 10.0.0.38
2025-08-11 02:36:57,213 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/virtual-networks
2025-08-11 02:36:57,500 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/virtual-networks
2025-08-11 02:36:57,555 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319', 'href': 'http://10.0.0.38:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319?flat'}
2025-08-11 02:36:57,555 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319 virtual network link through opserver 10.0.0.141
2025-08-11 02:36:57,555 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2025-08-11 02:36:57,843 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2025-08-11 02:36:57,894 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319?flat'}
2025-08-11 02:36:57,894 - INFO - Validated that VN default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319 is found in opserver
2025-08-11 02:36:57,916 - DEBUG - Do not have enough data to verify VN in agent
2025-08-11 02:36:57,925 - DEBUG - VRF ids for VN ctest-VN1-64990319: {}
2025-08-11 02:36:57,925 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:36:57,931 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:36:57,943 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:36:58,041 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/5ddf9d75-1fec-4981-813f-8dbd0d9b782a
2025-08-11 02:36:58,057 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/5ddf9d75-1fec-4981-813f-8dbd0d9b782a
2025-08-11 02:36:58,068 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/257e83cb-2ad8-441e-9c48-6c8e95c77810
2025-08-11 02:36:58,074 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/257e83cb-2ad8-441e-9c48-6c8e95c77810
2025-08-11 02:36:58,081 - DEBUG - Requesting: http://10.0.0.23:8082/route-target/675b9093-8de6-4067-96ca-b47c1b9fb5e9
2025-08-11 02:36:58,088 - DEBUG - Route Targets: ['target:64512:8000006']
2025-08-11 02:36:58,088 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/5ddf9d75-1fec-4981-813f-8dbd0d9b782a
2025-08-11 02:36:58,096 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/257e83cb-2ad8-441e-9c48-6c8e95c77810
2025-08-11 02:36:58,111 - INFO - Verified VN network id 13 for VN 5ddf9d75-1fec-4981-813f-8dbd0d9b782a
2025-08-11 02:36:58,111 - INFO - Verifications in API Server for VN ctest-VN2-43822279 passed
2025-08-11 02:36:58,111 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/5ddf9d75-1fec-4981-813f-8dbd0d9b782a
2025-08-11 02:36:58,120 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/257e83cb-2ad8-441e-9c48-6c8e95c77810
2025-08-11 02:36:58,126 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/257e83cb-2ad8-441e-9c48-6c8e95c77810
2025-08-11 02:36:58,134 - DEBUG - Requesting: http://10.0.0.23:8082/route-target/675b9093-8de6-4067-96ca-b47c1b9fb5e9
2025-08-11 02:36:58,146 - DEBUG - Control-node 10.0.0.23 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '6764298291706087809', 'uuid-lslong': '9313318397542103082'}, 'enable': 'true', 'created': '2025-08-11T02:36:55', 'last-modified': '2025-08-11T02:36:55', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:02.683761'}
2025-08-11 02:36:58,152 - DEBUG - Route Targets: ['target:64512:8000006']
2025-08-11 02:36:58,158 - DEBUG - Control-node 10.0.0.38 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '6764298291706087809', 'uuid-lslong': '9313318397542103082'}, 'enable': 'true', 'created': '2025-08-11T02:36:55', 'last-modified': '2025-08-11T02:36:55', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:02.698964'}
2025-08-11 02:36:58,164 - DEBUG - Route Targets: ['target:64512:8000006']
2025-08-11 02:36:58,169 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '6764298291706087809', 'uuid-lslong': '9313318397542103082'}, 'enable': 'true', 'created': '2025-08-11T02:36:55', 'last-modified': '2025-08-11T02:36:55', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:02.710990'}
2025-08-11 02:36:58,176 - DEBUG - Route Targets: ['target:64512:8000006']
2025-08-11 02:36:58,176 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-VN2-43822279 passed
2025-08-11 02:36:58,176 - DEBUG - ====Verifying policy data for ctest-VN2-43822279 in API_Server ======
2025-08-11 02:36:58,176 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:36:58,182 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:36:58,193 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:36:58,277 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/5ddf9d75-1fec-4981-813f-8dbd0d9b782a
2025-08-11 02:36:58,286 - DEBUG - =>VN ctest-VN2-43822279 has no policy to be verified
2025-08-11 02:36:58,286 - DEBUG - Verifying the vn in opserver
2025-08-11 02:36:58,286 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279 virtual network link through opserver 10.0.0.23
2025-08-11 02:36:58,286 - DEBUG - Requesting: http://10.0.0.23:8081/analytics/uves/virtual-networks
2025-08-11 02:36:58,338 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279', 'href': 'http://10.0.0.23:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279?flat'}
2025-08-11 02:36:58,338 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279 virtual network link through opserver 10.0.0.38
2025-08-11 02:36:58,339 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/virtual-networks
2025-08-11 02:36:58,386 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279', 'href': 'http://10.0.0.38:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279?flat'}
2025-08-11 02:36:58,386 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279 virtual network link through opserver 10.0.0.141
2025-08-11 02:36:58,386 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2025-08-11 02:36:58,432 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279?flat'}
2025-08-11 02:36:58,432 - INFO - Validated that VN default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279 is found in opserver
2025-08-11 02:36:58,454 - DEBUG - Do not have enough data to verify VN in agent
2025-08-11 02:36:58,464 - DEBUG - VRF ids for VN ctest-VN2-43822279: {}
2025-08-11 02:36:58,464 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:36:58,470 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:36:58,481 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:36:58,576 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/bfa027b5-81b0-471a-b961-64cbcfa4d363
2025-08-11 02:36:58,591 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/bfa027b5-81b0-471a-b961-64cbcfa4d363
2025-08-11 02:36:58,601 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/382d531c-3248-4247-b4f7-cc6d919113a9
2025-08-11 02:36:58,610 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/382d531c-3248-4247-b4f7-cc6d919113a9
2025-08-11 02:36:58,617 - DEBUG - Requesting: http://10.0.0.23:8082/route-target/57c2d269-50ff-43cc-8b07-9963c2ddbd3c
2025-08-11 02:36:58,624 - DEBUG - Route Targets: ['target:64512:8000007']
2025-08-11 02:36:58,624 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/bfa027b5-81b0-471a-b961-64cbcfa4d363
2025-08-11 02:36:58,633 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/382d531c-3248-4247-b4f7-cc6d919113a9
2025-08-11 02:36:58,650 - INFO - Verified VN network id 14 for VN bfa027b5-81b0-471a-b961-64cbcfa4d363
2025-08-11 02:36:58,650 - INFO - Verifications in API Server for VN ctest-VN3-77129969 passed
2025-08-11 02:36:58,650 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/bfa027b5-81b0-471a-b961-64cbcfa4d363
2025-08-11 02:36:58,660 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/382d531c-3248-4247-b4f7-cc6d919113a9
2025-08-11 02:36:58,670 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/382d531c-3248-4247-b4f7-cc6d919113a9
2025-08-11 02:36:58,676 - DEBUG - Requesting: http://10.0.0.23:8082/route-target/57c2d269-50ff-43cc-8b07-9963c2ddbd3c
2025-08-11 02:36:58,687 - DEBUG - Control-node 10.0.0.23 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '13808080118036317978', 'uuid-lslong': '13358068796282426211'}, 'enable': 'true', 'created': '2025-08-11T02:36:56', 'last-modified': '2025-08-11T02:36:56', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:02.392446'}
2025-08-11 02:36:58,693 - DEBUG - Route Targets: ['target:64512:8000007']
2025-08-11 02:36:58,699 - DEBUG - Control-node 10.0.0.38 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '13808080118036317978', 'uuid-lslong': '13358068796282426211'}, 'enable': 'true', 'created': '2025-08-11T02:36:56', 'last-modified': '2025-08-11T02:36:56', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:02.398107'}
2025-08-11 02:36:58,705 - DEBUG - Route Targets: ['target:64512:8000007']
2025-08-11 02:36:58,711 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '13808080118036317978', 'uuid-lslong': '13358068796282426211'}, 'enable': 'true', 'created': '2025-08-11T02:36:56', 'last-modified': '2025-08-11T02:36:56', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:02.412596'}
2025-08-11 02:36:58,719 - DEBUG - Route Targets: ['target:64512:8000007']
2025-08-11 02:36:58,719 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-VN3-77129969 passed
2025-08-11 02:36:58,719 - DEBUG - ====Verifying policy data for ctest-VN3-77129969 in API_Server ======
2025-08-11 02:36:58,720 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:36:58,728 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:36:58,742 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:36:58,829 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/bfa027b5-81b0-471a-b961-64cbcfa4d363
2025-08-11 02:36:58,840 - DEBUG - =>VN ctest-VN3-77129969 has no policy to be verified
2025-08-11 02:36:58,840 - DEBUG - Verifying the vn in opserver
2025-08-11 02:36:58,840 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969 virtual network link through opserver 10.0.0.23
2025-08-11 02:36:58,840 - DEBUG - Requesting: http://10.0.0.23:8081/analytics/uves/virtual-networks
2025-08-11 02:36:58,891 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969', 'href': 'http://10.0.0.23:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969?flat'}
2025-08-11 02:36:58,892 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969 virtual network link through opserver 10.0.0.38
2025-08-11 02:36:58,892 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/virtual-networks
2025-08-11 02:36:58,942 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969', 'href': 'http://10.0.0.38:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969?flat'}
2025-08-11 02:36:58,942 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969 virtual network link through opserver 10.0.0.141
2025-08-11 02:36:58,942 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2025-08-11 02:36:58,991 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969?flat'}
2025-08-11 02:36:58,991 - INFO - Validated that VN default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-77129969 is found in opserver
2025-08-11 02:36:59,012 - DEBUG - Do not have enough data to verify VN in agent
2025-08-11 02:36:59,023 - DEBUG - VRF ids for VN ctest-VN3-77129969: {}
2025-08-11 02:36:59,029 - DEBUG - No source network defined
2025-08-11 02:36:59,029 - DEBUG - Policy np_rules : [rule_sequence = None, rule_uuid = None, direction = <>, protocol = icmp, src_addresses = [subnet = ip_prefix = 12.157.137.0, ip_prefix_len = 26, virtual_network = None, 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 = deny, 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, rule_sequence = None, rule_uuid = None, direction = <>, protocol = any, src_addresses = [subnet = None, virtual_network = default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319, security_group = None, network_policy = None, subnet_list = []], src_ports = [start_port = -1, end_port = -1], application = [], dst_addresses = [subnet = None, virtual_network = default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279, 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-08-11 02:36:59,295 - DEBUG - No destination network defined
2025-08-11 02:36:59,295 - 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 = ip_prefix = 12.157.137.0, ip_prefix_len = 26, virtual_network = None, security_group = None, network_policy = None, subnet_list = []], dst_ports = [start_port = -1, end_port = -1], action_list = simple_action = deny, 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, rule_sequence = None, rule_uuid = None, direction = <>, protocol = any, src_addresses = [subnet = None, virtual_network = default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-43822279, security_group = None, network_policy = None, subnet_list = []], src_ports = [start_port = -1, end_port = -1], application = [], dst_addresses = [subnet = None, virtual_network = default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-64990319, 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-08-11 02:36:59,503 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:36:59,510 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:36:59,522 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:36:59,622 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/6c551eef-a5cd-46d7-9323-e514a228178e
2025-08-11 02:36:59,637 - DEBUG - Setup step: Associating the policy to VN'
2025-08-11 02:36:59,723 - DEBUG - Response for mapping policy(s) with vn {'network': {'id': '6c551eef-a5cd-46d7-9323-e514a228178e', 'name': 'ctest-VN1-64990319', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': ['b63b8f4f-c243-46cb-9d1b-c0b678607ca9'], 'fq_name': ['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-VN1-64990319'], 'policys': [['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-policy12-46858439']], 'subnet_ipam': [{'subnet_cidr': '12.157.137.0/26', 'ipam_fq_name': ['default-domain', 'ctest-TestPolicyAcl-44915902', 'ipam1']}], 'port_security_enabled': True, 'description': ''}}
2025-08-11 02:36:59,817 - DEBUG - Associated Policy:[['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-policy12-46858439']] to ctest-VN1-64990319
2025-08-11 02:36:59,817 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:36:59,824 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:36:59,838 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:36:59,920 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/5ddf9d75-1fec-4981-813f-8dbd0d9b782a
2025-08-11 02:36:59,933 - DEBUG - Setup step: Associating the policy to VN'
2025-08-11 02:37:00,019 - DEBUG - Response for mapping policy(s) with vn {'network': {'id': '5ddf9d75-1fec-4981-813f-8dbd0d9b782a', 'name': 'ctest-VN2-43822279', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': ['dbff6640-9a5c-4fbb-9acf-4334edd0a8a9'], 'fq_name': ['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-VN2-43822279'], 'policys': [['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-policy21-30257470']], 'subnet_ipam': [{'subnet_cidr': '103.49.205.0/26', 'ipam_fq_name': ['default-domain', 'ctest-TestPolicyAcl-44915902', 'ipam2']}], 'port_security_enabled': True, 'description': ''}}
2025-08-11 02:37:00,150 - DEBUG - Associated Policy:[['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-policy21-30257470']] to ctest-VN2-43822279
2025-08-11 02:37:00,253 - DEBUG - Services list from nova: [, , , ]
2025-08-11 02:37:00,277 - DEBUG - Image by name ubuntu not found
2025-08-11 02:37:00,277 - DEBUG - Installing image ubuntu
2025-08-11 02:37:00,277 - DEBUG - Image info {'name': 'ubuntu.vmdk.gz', 'webserver': '', 'location': '/images/converts/', 'username': 'ubuntu', 'password': 'ubuntu', 'type': 'os', 'flavor': 'contrail_flavor_tiny', 'params': '--container-format bare --disk-format vmdk --property vmware_disktype="sparse" --property vmware_adaptertype="ide" --property hw_scsi_model=virtio-scsi --property hw_disk_bus_model=virtio-scsi --property hw_disk_bus=virtio', 'name_docker': 'phusion-baseimage-enablesshd'}
2025-08-11 02:37:00,278 - DEBUG - Image build path file:///contrail-test/images/ubuntu.vmdk.gz
2025-08-11 02:37:00,278 - DEBUG - Download image from local file file:///contrail-test/images/ubuntu.vmdk.gz
2025-08-11 02:37:00,278 - DEBUG - Unzip image
2025-08-11 02:37:00,278 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: gunzip -f /contrail-test/images/ubuntu.vmdk.gz
2025-08-11 02:37:00,295 - INFO - image /contrail-test/images/ubuntu.vmdk is not found
2025-08-11 02:37:00,296 - DEBUG - Detaching the Policy for VN :ctest-VN2-43822279
2025-08-11 02:37:00,296 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:00,304 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:00,320 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:00,417 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/5ddf9d75-1fec-4981-813f-8dbd0d9b782a
2025-08-11 02:37:00,439 - DEBUG - Requesting: http://10.0.0.23:8082/network-policy/8d9b23e6-5a9a-423d-8f63-09274cf572dd
2025-08-11 02:37:00,649 - DEBUG - Detached Policy:[['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-policy21-30257470']] from ctest-VN2-43822279
2025-08-11 02:37:00,649 - DEBUG - Detaching the Policy for VN :ctest-VN1-64990319
2025-08-11 02:37:00,649 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:00,693 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:00,754 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:00,864 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/6c551eef-a5cd-46d7-9323-e514a228178e
2025-08-11 02:37:00,881 - DEBUG - Requesting: http://10.0.0.23:8082/network-policy/d0fb24da-748b-4db5-af77-f7285aa7ce14
2025-08-11 02:37:01,029 - DEBUG - Detached Policy:[['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-policy12-46858439']] from ctest-VN1-64990319
2025-08-11 02:37:01,084 - INFO - Deleted policy ctest-policy21-30257470
2025-08-11 02:37:01,141 - INFO - Deleted policy ctest-policy12-46858439
2025-08-11 02:37:01,141 - INFO - Deleting VN ctest-VN3-77129969
2025-08-11 02:37:01,285 - DEBUG - Response for deleting network ()
2025-08-11 02:37:01,285 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/382d531c-3248-4247-b4f7-cc6d919113a9
2025-08-11 02:37:01,290 - DEBUG - Response Code: 404
2025-08-11 02:37:01,290 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:01,303 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:01,316 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:01,405 - INFO - Validated that VN ctest-VN3-77129969 is not found in API Server
2025-08-11 02:37:01,420 - DEBUG - VN ctest-VN3-77129969 is not present in Agent 10.0.0.57
2025-08-11 02:37:01,432 - DEBUG - VN ctest-VN3-77129969 is not present in Agent 10.0.0.65
2025-08-11 02:37:01,432 - INFO - Validated that VN ctest-VN3-77129969 is not in any agent
2025-08-11 02:37:01,467 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-VN3-77129969 info
2025-08-11 02:37:01,467 - INFO - Deleting VN ctest-VN2-43822279
2025-08-11 02:37:01,613 - DEBUG - Response for deleting network ()
2025-08-11 02:37:01,613 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/257e83cb-2ad8-441e-9c48-6c8e95c77810
2025-08-11 02:37:01,621 - DEBUG - Response Code: 404
2025-08-11 02:37:01,621 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:01,627 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:01,685 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:01,775 - INFO - Validated that VN ctest-VN2-43822279 is not found in API Server
2025-08-11 02:37:01,790 - DEBUG - VN ctest-VN2-43822279 is not present in Agent 10.0.0.57
2025-08-11 02:37:01,800 - DEBUG - VN ctest-VN2-43822279 is not present in Agent 10.0.0.65
2025-08-11 02:37:01,800 - INFO - Validated that VN ctest-VN2-43822279 is not in any agent
2025-08-11 02:37:01,834 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-VN2-43822279 info
2025-08-11 02:37:01,834 - INFO - Deleting VN ctest-VN1-64990319
2025-08-11 02:37:01,984 - DEBUG - Response for deleting network ()
2025-08-11 02:37:01,984 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/27d64c97-e5a8-4308-a9c7-302a0fd06bb9
2025-08-11 02:37:01,991 - DEBUG - Response Code: 404
2025-08-11 02:37:01,991 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:02,003 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:02,021 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:02,110 - INFO - Validated that VN ctest-VN1-64990319 is not found in API Server
2025-08-11 02:37:02,122 - DEBUG - VN ctest-VN1-64990319 is not present in Agent 10.0.0.57
2025-08-11 02:37:02,134 - DEBUG - VN ctest-VN1-64990319 is not present in Agent 10.0.0.65
2025-08-11 02:37:02,134 - INFO - Validated that VN ctest-VN1-64990319 is not in any agent
2025-08-11 02:37:02,166 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-VN1-64990319 info
2025-08-11 02:37:02,255 - INFO - IPAM: ipam3 is not found in API Server
2025-08-11 02:37:02,277 - INFO - IPAM:ipam3 is not found in control node
2025-08-11 02:37:02,410 - INFO - IPAM: ipam2 is not found in API Server
2025-08-11 02:37:02,437 - INFO - IPAM:ipam2 is not found in control node
2025-08-11 02:37:02,567 - INFO - IPAM: ipam1 is not found in API Server
2025-08-11 02:37:02,588 - INFO - IPAM:ipam1 is not found in control node
2025-08-11 02:37:03,852 - DEBUG - No XMPP flaps were noticed during the test
2025-08-11 02:37:03,852 - INFO -
2025-08-11 02:37:03,852 - INFO - END TEST : test_policy_cidr_src_cidr_dst_any : SKIPPED[0:00:13]
2025-08-11 02:37:03,852 - INFO - --------------------------------------------------------------------------------
2025-08-11 02:37:03,855 - INFO - ================================================================================
2025-08-11 02:37:03,856 - INFO - STARTING TEST : test_policy_inheritance_src_vn_dst_pol
2025-08-11 02:37:03,856 - INFO - TEST DESCRIPTION : Test cases to test policy inheritance
2025-08-11 02:37:05,116 - DEBUG - Nothing to compare xmpp stats {'10.0.0.57': {'10.20.0.18': '0', '10.20.0.129': '0'}, '10.0.0.65': {'10.20.0.129': '0', '10.20.0.25': '0'}} with
2025-08-11 02:37:05,116 - INFO - Initial checks done. Running the testcase now
2025-08-11 02:37:05,116 - INFO -
2025-08-11 02:37:06,083 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:06,090 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:06,102 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:06,198 - DEBUG - Requesting: http://10.0.0.23:8082/network-ipam/e83d6bf6-1ccd-4636-93d4-79f25976b8ae
2025-08-11 02:37:06,206 - INFO - Verifications in API Server for IPAM: ipam1 passed
2025-08-11 02:37:06,213 - DEBUG - Control-node 10.0.0.23 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam1', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '16734650495167972918', 'uuid-lslong': '10652273100428064942'}, 'enable': 'true', 'created': '2025-08-11T02:37:05', 'last-modified': '2025-08-11T02:37:05', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.833219'}
2025-08-11 02:37:06,220 - DEBUG - Control-node 10.0.0.38 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam1', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '16734650495167972918', 'uuid-lslong': '10652273100428064942'}, 'enable': 'true', 'created': '2025-08-11T02:37:05', 'last-modified': '2025-08-11T02:37:05', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.840356'}
2025-08-11 02:37:06,227 - DEBUG - Control-node 10.0.0.141 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam1', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '16734650495167972918', 'uuid-lslong': '10652273100428064942'}, 'enable': 'true', 'created': '2025-08-11T02:37:05', 'last-modified': '2025-08-11T02:37:05', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.849077'}
2025-08-11 02:37:06,227 - INFO - Verifications in Control node for IPAM: ipam1 passed
2025-08-11 02:37:06,227 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:06,235 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:06,250 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:06,357 - DEBUG - Requesting: http://10.0.0.23:8082/network-ipam/f28eb2ed-2b9f-4784-96f3-0c88a96755df
2025-08-11 02:37:06,370 - INFO - Verifications in API Server for IPAM: ipam2 passed
2025-08-11 02:37:06,376 - DEBUG - Control-node 10.0.0.23 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam2', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '17478103935580325764', 'uuid-lslong': '10877051306127087071'}, 'enable': 'true', 'created': '2025-08-11T02:37:05', 'last-modified': '2025-08-11T02:37:05', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.660164'}
2025-08-11 02:37:06,382 - DEBUG - Control-node 10.0.0.38 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam2', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '17478103935580325764', 'uuid-lslong': '10877051306127087071'}, 'enable': 'true', 'created': '2025-08-11T02:37:05', 'last-modified': '2025-08-11T02:37:05', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.666878'}
2025-08-11 02:37:06,388 - DEBUG - Control-node 10.0.0.141 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam2', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '17478103935580325764', 'uuid-lslong': '10877051306127087071'}, 'enable': 'true', 'created': '2025-08-11T02:37:05', 'last-modified': '2025-08-11T02:37:05', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.672600'}
2025-08-11 02:37:06,388 - INFO - Verifications in Control node for IPAM: ipam2 passed
2025-08-11 02:37:06,388 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:06,394 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:06,406 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:06,500 - DEBUG - Requesting: http://10.0.0.23:8082/network-ipam/aefb394c-9eb6-4f32-a904-1f772d0299a2
2025-08-11 02:37:06,508 - INFO - Verifications in API Server for IPAM: ipam3 passed
2025-08-11 02:37:06,515 - DEBUG - Control-node 10.0.0.23 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam3', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '12608734582996881202', 'uuid-lslong': '12178893889033378210'}, 'enable': 'true', 'created': '2025-08-11T02:37:05', 'last-modified': '2025-08-11T02:37:06', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.461657'}
2025-08-11 02:37:06,522 - DEBUG - Control-node 10.0.0.38 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam3', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '12608734582996881202', 'uuid-lslong': '12178893889033378210'}, 'enable': 'true', 'created': '2025-08-11T02:37:05', 'last-modified': '2025-08-11T02:37:06', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.473280'}
2025-08-11 02:37:06,529 - DEBUG - Control-node 10.0.0.141 : IPAM object is : {'node_name': 'network-ipam:default-domain:ctest-TestPolicyAcl-44915902:ipam3', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '12608734582996881202', 'uuid-lslong': '12178893889033378210'}, 'enable': 'true', 'created': '2025-08-11T02:37:05', 'last-modified': '2025-08-11T02:37:06', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:00.475827'}
2025-08-11 02:37:06,529 - INFO - Verifications in Control node for IPAM: ipam3 passed
2025-08-11 02:37:06,777 - DEBUG - Response for create_network : {'network': {'id': 'c02d5020-8584-44be-9c55-2d8654b98377', 'name': 'ctest-VN1-91708207', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-VN1-91708207'], 'port_security_enabled': True, 'description': ''}}
2025-08-11 02:37:07,006 - DEBUG - Response for create_subnet : {'subnet': {'id': '8ea9766e-3afe-4213-bb86-856b34a05e79', 'name': '', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'network_id': 'c02d5020-8584-44be-9c55-2d8654b98377', 'ip_version': 4, 'cidr': '136.126.191.128/26', 'allocation_pools': [{'start': '136.126.191.130', 'end': '136.126.191.190'}], 'gateway_ip': '136.126.191.129', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '136.126.191.130', 'tags': [], 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe'}}
2025-08-11 02:37:07,027 - INFO - Created VN ctest-VN1-91708207
2025-08-11 02:37:07,040 - DEBUG - VN ctest-VN1-91708207 UUID is c02d5020-8584-44be-9c55-2d8654b98377
2025-08-11 02:37:07,183 - DEBUG - Fetched VN: default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207(c02d5020-8584-44be-9c55-2d8654b98377) with subnets ['136.126.191.128/26']
2025-08-11 02:37:07,480 - DEBUG - Response for create_network : {'network': {'id': '59384e25-02c7-4a37-9636-4465d5aa5ea6', 'name': 'ctest-VN2-13356290', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-VN2-13356290'], 'port_security_enabled': True, 'description': ''}}
2025-08-11 02:37:07,711 - DEBUG - Response for create_subnet : {'subnet': {'id': '17a46803-2204-4e8f-98e6-41006f06e244', 'name': '', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'network_id': '59384e25-02c7-4a37-9636-4465d5aa5ea6', 'ip_version': 4, 'cidr': '190.96.18.192/26', 'allocation_pools': [{'start': '190.96.18.194', 'end': '190.96.18.254'}], 'gateway_ip': '190.96.18.193', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '190.96.18.194', 'tags': [], 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe'}}
2025-08-11 02:37:07,734 - INFO - Created VN ctest-VN2-13356290
2025-08-11 02:37:07,746 - DEBUG - VN ctest-VN2-13356290 UUID is 59384e25-02c7-4a37-9636-4465d5aa5ea6
2025-08-11 02:37:08,091 - DEBUG - Response for create_network : {'network': {'id': '6d8abc7c-973a-4cc5-9b70-eed7c7fe1005', 'name': 'ctest-VN3-08745714', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-VN3-08745714'], 'port_security_enabled': True, 'description': ''}}
2025-08-11 02:37:08,300 - DEBUG - Response for create_subnet : {'subnet': {'id': '49589bcc-6e93-4968-bdef-53e98556158b', 'name': '', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'network_id': '6d8abc7c-973a-4cc5-9b70-eed7c7fe1005', 'ip_version': 4, 'cidr': '101.13.144.128/26', 'allocation_pools': [{'start': '101.13.144.130', 'end': '101.13.144.190'}], 'gateway_ip': '101.13.144.129', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '101.13.144.130', 'tags': [], 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe'}}
2025-08-11 02:37:08,332 - INFO - Created VN ctest-VN3-08745714
2025-08-11 02:37:08,345 - DEBUG - VN ctest-VN3-08745714 UUID is 6d8abc7c-973a-4cc5-9b70-eed7c7fe1005
2025-08-11 02:37:08,417 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:08,423 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:08,436 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:08,528 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/c02d5020-8584-44be-9c55-2d8654b98377
2025-08-11 02:37:08,543 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/c02d5020-8584-44be-9c55-2d8654b98377
2025-08-11 02:37:08,554 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/103bd1cc-edb8-47f5-9ffe-ab6b32dbffc6
2025-08-11 02:37:08,563 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/103bd1cc-edb8-47f5-9ffe-ab6b32dbffc6
2025-08-11 02:37:08,570 - DEBUG - Requesting: http://10.0.0.23:8082/route-target/bb6d12c2-2d02-4e21-99ff-96c56a06bd9f
2025-08-11 02:37:08,577 - DEBUG - Route Targets: ['target:64512:8000005']
2025-08-11 02:37:08,577 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/c02d5020-8584-44be-9c55-2d8654b98377
2025-08-11 02:37:08,586 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/103bd1cc-edb8-47f5-9ffe-ab6b32dbffc6
2025-08-11 02:37:08,601 - INFO - Verified VN network id 12 for VN c02d5020-8584-44be-9c55-2d8654b98377
2025-08-11 02:37:08,601 - INFO - Verifications in API Server for VN ctest-VN1-91708207 passed
2025-08-11 02:37:08,601 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/c02d5020-8584-44be-9c55-2d8654b98377
2025-08-11 02:37:08,611 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/103bd1cc-edb8-47f5-9ffe-ab6b32dbffc6
2025-08-11 02:37:08,620 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/103bd1cc-edb8-47f5-9ffe-ab6b32dbffc6
2025-08-11 02:37:08,628 - DEBUG - Requesting: http://10.0.0.23:8082/route-target/bb6d12c2-2d02-4e21-99ff-96c56a06bd9f
2025-08-11 02:37:08,642 - DEBUG - Control-node 10.0.0.23 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '13847812529843356862', 'uuid-lslong': '11264960097907475319'}, 'enable': 'true', 'created': '2025-08-11T02:37:06', 'last-modified': '2025-08-11T02:37:06', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.687695'}
2025-08-11 02:37:08,649 - DEBUG - Route Targets: ['target:64512:8000005']
2025-08-11 02:37:08,655 - DEBUG - Control-node 10.0.0.38 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '13847812529843356862', 'uuid-lslong': '11264960097907475319'}, 'enable': 'true', 'created': '2025-08-11T02:37:06', 'last-modified': '2025-08-11T02:37:06', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.703414'}
2025-08-11 02:37:08,661 - DEBUG - Route Targets: ['target:64512:8000005']
2025-08-11 02:37:08,668 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '13847812529843356862', 'uuid-lslong': '11264960097907475319'}, 'enable': 'true', 'created': '2025-08-11T02:37:06', 'last-modified': '2025-08-11T02:37:06', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.715183'}
2025-08-11 02:37:08,674 - DEBUG - Route Targets: ['target:64512:8000005']
2025-08-11 02:37:08,674 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-VN1-91708207 passed
2025-08-11 02:37:08,675 - DEBUG - ====Verifying policy data for ctest-VN1-91708207 in API_Server ======
2025-08-11 02:37:08,675 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:08,685 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:08,695 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:08,785 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/c02d5020-8584-44be-9c55-2d8654b98377
2025-08-11 02:37:08,795 - DEBUG - =>VN ctest-VN1-91708207 has no policy to be verified
2025-08-11 02:37:08,795 - DEBUG - Verifying the vn in opserver
2025-08-11 02:37:08,795 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207 virtual network link through opserver 10.0.0.23
2025-08-11 02:37:08,795 - DEBUG - Requesting: http://10.0.0.23:8081/analytics/uves/virtual-networks
2025-08-11 02:37:08,807 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207', 'href': 'http://10.0.0.23:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207?flat'}
2025-08-11 02:37:08,807 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207 virtual network link through opserver 10.0.0.38
2025-08-11 02:37:08,807 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/virtual-networks
2025-08-11 02:37:08,820 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207', 'href': 'http://10.0.0.38:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207?flat'}
2025-08-11 02:37:08,820 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207 virtual network link through opserver 10.0.0.141
2025-08-11 02:37:08,820 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2025-08-11 02:37:08,833 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207?flat'}
2025-08-11 02:37:08,833 - INFO - Validated that VN default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207 is found in opserver
2025-08-11 02:37:08,859 - DEBUG - Do not have enough data to verify VN in agent
2025-08-11 02:37:08,869 - DEBUG - VRF ids for VN ctest-VN1-91708207: {}
2025-08-11 02:37:08,869 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:08,875 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:08,887 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:08,972 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/59384e25-02c7-4a37-9636-4465d5aa5ea6
2025-08-11 02:37:08,984 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/59384e25-02c7-4a37-9636-4465d5aa5ea6
2025-08-11 02:37:08,996 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/0f8417e1-b762-45fd-ac07-16405850b41d
2025-08-11 02:37:09,004 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/0f8417e1-b762-45fd-ac07-16405850b41d
2025-08-11 02:37:09,011 - DEBUG - Requesting: http://10.0.0.23:8082/route-target/b7eed80b-7aef-4737-b401-45d57ab75914
2025-08-11 02:37:09,019 - DEBUG - Route Targets: ['target:64512:8000006']
2025-08-11 02:37:09,019 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/59384e25-02c7-4a37-9636-4465d5aa5ea6
2025-08-11 02:37:09,029 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/0f8417e1-b762-45fd-ac07-16405850b41d
2025-08-11 02:37:09,046 - INFO - Verified VN network id 13 for VN 59384e25-02c7-4a37-9636-4465d5aa5ea6
2025-08-11 02:37:09,046 - INFO - Verifications in API Server for VN ctest-VN2-13356290 passed
2025-08-11 02:37:09,046 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/59384e25-02c7-4a37-9636-4465d5aa5ea6
2025-08-11 02:37:09,057 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/0f8417e1-b762-45fd-ac07-16405850b41d
2025-08-11 02:37:09,064 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/0f8417e1-b762-45fd-ac07-16405850b41d
2025-08-11 02:37:09,071 - DEBUG - Requesting: http://10.0.0.23:8082/route-target/b7eed80b-7aef-4737-b401-45d57ab75914
2025-08-11 02:37:09,085 - DEBUG - Control-node 10.0.0.23 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '6428974388938754615', 'uuid-lslong': '10823913958598663846'}, 'enable': 'true', 'created': '2025-08-11T02:37:07', 'last-modified': '2025-08-11T02:37:07', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.428799'}
2025-08-11 02:37:09,093 - DEBUG - Route Targets: ['target:64512:8000006']
2025-08-11 02:37:09,098 - DEBUG - Control-node 10.0.0.38 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '6428974388938754615', 'uuid-lslong': '10823913958598663846'}, 'enable': 'true', 'created': '2025-08-11T02:37:07', 'last-modified': '2025-08-11T02:37:07', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.443292'}
2025-08-11 02:37:09,104 - DEBUG - Route Targets: ['target:64512:8000006']
2025-08-11 02:37:09,111 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '6428974388938754615', 'uuid-lslong': '10823913958598663846'}, 'enable': 'true', 'created': '2025-08-11T02:37:07', 'last-modified': '2025-08-11T02:37:07', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.453508'}
2025-08-11 02:37:09,117 - DEBUG - Route Targets: ['target:64512:8000006']
2025-08-11 02:37:09,117 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-VN2-13356290 passed
2025-08-11 02:37:09,118 - DEBUG - ====Verifying policy data for ctest-VN2-13356290 in API_Server ======
2025-08-11 02:37:09,118 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:09,124 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:09,137 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:09,222 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/59384e25-02c7-4a37-9636-4465d5aa5ea6
2025-08-11 02:37:09,234 - DEBUG - =>VN ctest-VN2-13356290 has no policy to be verified
2025-08-11 02:37:09,234 - DEBUG - Verifying the vn in opserver
2025-08-11 02:37:09,234 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290 virtual network link through opserver 10.0.0.23
2025-08-11 02:37:09,234 - DEBUG - Requesting: http://10.0.0.23:8081/analytics/uves/virtual-networks
2025-08-11 02:37:09,248 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290', 'href': 'http://10.0.0.23:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290?flat'}
2025-08-11 02:37:09,248 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290 virtual network link through opserver 10.0.0.38
2025-08-11 02:37:09,248 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/virtual-networks
2025-08-11 02:37:09,260 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290', 'href': 'http://10.0.0.38:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290?flat'}
2025-08-11 02:37:09,260 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290 virtual network link through opserver 10.0.0.141
2025-08-11 02:37:09,260 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2025-08-11 02:37:09,273 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290?flat'}
2025-08-11 02:37:09,273 - INFO - Validated that VN default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290 is found in opserver
2025-08-11 02:37:09,296 - DEBUG - Do not have enough data to verify VN in agent
2025-08-11 02:37:09,306 - DEBUG - VRF ids for VN ctest-VN2-13356290: {}
2025-08-11 02:37:09,306 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:09,314 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:09,327 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:09,418 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/6d8abc7c-973a-4cc5-9b70-eed7c7fe1005
2025-08-11 02:37:09,430 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/6d8abc7c-973a-4cc5-9b70-eed7c7fe1005
2025-08-11 02:37:09,442 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/11a6652c-94a5-4d4d-bffc-4d8a21386ed6
2025-08-11 02:37:09,451 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/11a6652c-94a5-4d4d-bffc-4d8a21386ed6
2025-08-11 02:37:09,459 - DEBUG - Requesting: http://10.0.0.23:8082/route-target/0fb5310b-c054-420c-b5d2-2b623d1e4406
2025-08-11 02:37:09,465 - DEBUG - Route Targets: ['target:64512:8000007']
2025-08-11 02:37:09,465 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/6d8abc7c-973a-4cc5-9b70-eed7c7fe1005
2025-08-11 02:37:09,474 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/11a6652c-94a5-4d4d-bffc-4d8a21386ed6
2025-08-11 02:37:09,490 - INFO - Verified VN network id 14 for VN 6d8abc7c-973a-4cc5-9b70-eed7c7fe1005
2025-08-11 02:37:09,490 - INFO - Verifications in API Server for VN ctest-VN3-08745714 passed
2025-08-11 02:37:09,490 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/6d8abc7c-973a-4cc5-9b70-eed7c7fe1005
2025-08-11 02:37:09,499 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/11a6652c-94a5-4d4d-bffc-4d8a21386ed6
2025-08-11 02:37:09,505 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/11a6652c-94a5-4d4d-bffc-4d8a21386ed6
2025-08-11 02:37:09,513 - DEBUG - Requesting: http://10.0.0.23:8082/route-target/0fb5310b-c054-420c-b5d2-2b623d1e4406
2025-08-11 02:37:09,530 - DEBUG - Control-node 10.0.0.23 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '7893328540219362501', 'uuid-lslong': '11200714883811119109'}, 'enable': 'true', 'created': '2025-08-11T02:37:08', 'last-modified': '2025-08-11T02:37:08', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.278847'}
2025-08-11 02:37:09,539 - DEBUG - Route Targets: ['target:64512:8000007']
2025-08-11 02:37:09,546 - DEBUG - Control-node 10.0.0.38 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '7893328540219362501', 'uuid-lslong': '11200714883811119109'}, 'enable': 'true', 'created': '2025-08-11T02:37:08', 'last-modified': '2025-08-11T02:37:08', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.297725'}
2025-08-11 02:37:09,553 - DEBUG - Route Targets: ['target:64512:8000007']
2025-08-11 02:37:09,560 - DEBUG - Control-node 10.0.0.141 : VN object is : {'node_name': 'virtual-network:default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714', 'interests': '-', 'advertised': '-', 'dbentryflags': None, 'obj_info': {'sequence_number': '0', 'origin': 'Cassandra', 'data': {'id-perms': {'permissions': {'owner': 'ctest-TestPolicyAcl-44915902', 'owner-access': '7', 'group': 'admin', 'group-access': '7', 'other-access': '7'}, 'uuid': {'uuid-mslong': '7893328540219362501', 'uuid-lslong': '11200714883811119109'}, 'enable': 'true', 'created': '2025-08-11T02:37:08', 'last-modified': '2025-08-11T02:37:08', 'description': None, 'user-visible': 'true', 'creator': None}}}, 'neighbors': None, 'last_modified': '00:00:01.309700'}
2025-08-11 02:37:09,567 - DEBUG - Route Targets: ['target:64512:8000007']
2025-08-11 02:37:09,567 - INFO - On all control nodes, Config, RI and RT verification for VN ctest-VN3-08745714 passed
2025-08-11 02:37:09,568 - DEBUG - ====Verifying policy data for ctest-VN3-08745714 in API_Server ======
2025-08-11 02:37:09,568 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:09,574 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:09,586 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:09,686 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/6d8abc7c-973a-4cc5-9b70-eed7c7fe1005
2025-08-11 02:37:09,696 - DEBUG - =>VN ctest-VN3-08745714 has no policy to be verified
2025-08-11 02:37:09,696 - DEBUG - Verifying the vn in opserver
2025-08-11 02:37:09,696 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714 virtual network link through opserver 10.0.0.23
2025-08-11 02:37:09,696 - DEBUG - Requesting: http://10.0.0.23:8081/analytics/uves/virtual-networks
2025-08-11 02:37:09,709 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714', 'href': 'http://10.0.0.23:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714?flat'}
2025-08-11 02:37:09,709 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714 virtual network link through opserver 10.0.0.38
2025-08-11 02:37:09,710 - DEBUG - Requesting: http://10.0.0.38:8081/analytics/uves/virtual-networks
2025-08-11 02:37:09,723 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714', 'href': 'http://10.0.0.38:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714?flat'}
2025-08-11 02:37:09,723 - DEBUG - Verifying the default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714 virtual network link through opserver 10.0.0.141
2025-08-11 02:37:09,723 - DEBUG - Requesting: http://10.0.0.141:8081/analytics/uves/virtual-networks
2025-08-11 02:37:09,737 - DEBUG - vn link and name as {'name': 'default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714', 'href': 'http://10.0.0.141:8081/analytics/uves/virtual-network/default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714?flat'}
2025-08-11 02:37:09,737 - INFO - Validated that VN default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714 is found in opserver
2025-08-11 02:37:09,762 - DEBUG - Do not have enough data to verify VN in agent
2025-08-11 02:37:09,773 - DEBUG - VRF ids for VN ctest-VN3-08745714: {}
2025-08-11 02:37:09,779 - DEBUG - Policy np_rules : [rule_sequence = None, rule_uuid = None, direction = <>, protocol = icmp, src_addresses = [subnet = None, virtual_network = default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207, security_group = None, network_policy = None, subnet_list = []], src_ports = [start_port = -1, end_port = -1], application = [], dst_addresses = [subnet = None, virtual_network = default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290, 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-08-11 02:37:10,055 - DEBUG - No destination network defined
2025-08-11 02:37:10,055 - DEBUG - Policy np_rules : [rule_sequence = None, rule_uuid = None, direction = <>, protocol = icmp, src_addresses = [subnet = None, virtual_network = default-domain:ctest-TestPolicyAcl-44915902:ctest-VN2-13356290, security_group = None, network_policy = None, subnet_list = []], src_ports = [start_port = -1, end_port = -1], application = [], dst_addresses = [subnet = None, virtual_network = None, security_group = None, network_policy = default-domain:ctest-TestPolicyAcl-44915902:ctest-policy13-04685783, 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-08-11 02:37:10,319 - DEBUG - Policy np_rules : [rule_sequence = None, rule_uuid = None, direction = <>, protocol = any, src_addresses = [subnet = None, virtual_network = default-domain:ctest-TestPolicyAcl-44915902:ctest-VN1-91708207, security_group = None, network_policy = None, subnet_list = []], src_ports = [start_port = -1, end_port = -1], application = [], dst_addresses = [subnet = None, virtual_network = default-domain:ctest-TestPolicyAcl-44915902:ctest-VN3-08745714, security_group = None, network_policy = None, subnet_list = []], dst_ports = [start_port = -1, end_port = -1], action_list = simple_action = deny, 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-08-11 02:37:10,536 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:10,543 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:10,556 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:10,659 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/c02d5020-8584-44be-9c55-2d8654b98377
2025-08-11 02:37:10,670 - DEBUG - Setup step: Associating the policy to VN'
2025-08-11 02:37:10,835 - INFO - Associated Policy to ctest-VN1-91708207
2025-08-11 02:37:10,835 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:10,845 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:10,859 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:10,947 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/59384e25-02c7-4a37-9636-4465d5aa5ea6
2025-08-11 02:37:10,959 - DEBUG - Setup step: Associating the policy to VN'
2025-08-11 02:37:11,057 - DEBUG - Response for mapping policy(s) with vn {'network': {'id': '59384e25-02c7-4a37-9636-4465d5aa5ea6', 'name': 'ctest-VN2-13356290', 'tenant_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'project_id': 'be7cfb3902ce4e5d979137da70fd6cfe', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': ['17a46803-2204-4e8f-98e6-41006f06e244'], 'fq_name': ['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-VN2-13356290'], 'policys': [['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-policy21-16901251']], 'subnet_ipam': [{'subnet_cidr': '190.96.18.192/26', 'ipam_fq_name': ['default-domain', 'ctest-TestPolicyAcl-44915902', 'ipam2']}], 'port_security_enabled': True, 'description': ''}}
2025-08-11 02:37:11,146 - DEBUG - Associated Policy:[['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-policy21-16901251']] to ctest-VN2-13356290
2025-08-11 02:37:11,256 - DEBUG - Image by name ubuntu not found
2025-08-11 02:37:11,257 - DEBUG - Installing image ubuntu
2025-08-11 02:37:11,257 - DEBUG - Image info {'name': 'ubuntu.vmdk.gz', 'webserver': '', 'location': '/images/converts/', 'username': 'ubuntu', 'password': 'ubuntu', 'type': 'os', 'flavor': 'contrail_flavor_tiny', 'params': '--container-format bare --disk-format vmdk --property vmware_disktype="sparse" --property vmware_adaptertype="ide" --property hw_scsi_model=virtio-scsi --property hw_disk_bus_model=virtio-scsi --property hw_disk_bus=virtio', 'name_docker': 'phusion-baseimage-enablesshd'}
2025-08-11 02:37:11,257 - DEBUG - Image build path file:///contrail-test/images/ubuntu.vmdk.gz
2025-08-11 02:37:11,257 - DEBUG - Download image from local file file:///contrail-test/images/ubuntu.vmdk.gz
2025-08-11 02:37:11,257 - DEBUG - Unzip image
2025-08-11 02:37:11,257 - DEBUG - Image download (local=True) (proxy=None): Execute cmd: gunzip -f /contrail-test/images/ubuntu.vmdk.gz
2025-08-11 02:37:11,273 - INFO - image /contrail-test/images/ubuntu.vmdk is not found
2025-08-11 02:37:11,274 - DEBUG - Detaching the Policy for VN :ctest-VN2-13356290
2025-08-11 02:37:11,274 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:11,282 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:11,296 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:11,394 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/59384e25-02c7-4a37-9636-4465d5aa5ea6
2025-08-11 02:37:11,409 - DEBUG - Requesting: http://10.0.0.23:8082/network-policy/bae44648-7062-4f6d-aa86-843c38342ed8
2025-08-11 02:37:11,628 - DEBUG - Detached Policy:[['default-domain', 'ctest-TestPolicyAcl-44915902', 'ctest-policy21-16901251']] from ctest-VN2-13356290
2025-08-11 02:37:11,628 - DEBUG - Detaching the Policy for VN :ctest-VN1-91708207
2025-08-11 02:37:11,628 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:11,664 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:11,684 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:11,768 - DEBUG - Requesting: http://10.0.0.23:8082/virtual-network/c02d5020-8584-44be-9c55-2d8654b98377
2025-08-11 02:37:11,955 - INFO - Detached Policy from ctest-VN1-91708207
2025-08-11 02:37:12,036 - INFO - Deleted policy ctest-policy13-04685783
2025-08-11 02:37:12,083 - INFO - Deleted policy ctest-policy21-16901251
2025-08-11 02:37:12,123 - INFO - Deleted policy ctest-policy12-53568596
2025-08-11 02:37:12,124 - INFO - Deleting VN ctest-VN3-08745714
2025-08-11 02:37:12,353 - DEBUG - Response for deleting network ()
2025-08-11 02:37:12,353 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/11a6652c-94a5-4d4d-bffc-4d8a21386ed6
2025-08-11 02:37:12,365 - DEBUG - Response Code: 404
2025-08-11 02:37:12,365 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:12,372 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:12,384 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:12,470 - INFO - Validated that VN ctest-VN3-08745714 is not found in API Server
2025-08-11 02:37:12,482 - DEBUG - VN ctest-VN3-08745714 is not present in Agent 10.0.0.57
2025-08-11 02:37:12,492 - DEBUG - VN ctest-VN3-08745714 is not present in Agent 10.0.0.65
2025-08-11 02:37:12,493 - INFO - Validated that VN ctest-VN3-08745714 is not in any agent
2025-08-11 02:37:12,524 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-VN3-08745714 info
2025-08-11 02:37:12,524 - INFO - Deleting VN ctest-VN2-13356290
2025-08-11 02:37:12,652 - DEBUG - Response for deleting network ()
2025-08-11 02:37:12,653 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/0f8417e1-b762-45fd-ac07-16405850b41d
2025-08-11 02:37:12,668 - DEBUG - Response Code: 404
2025-08-11 02:37:12,668 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:12,675 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:12,687 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:12,779 - INFO - Validated that VN ctest-VN2-13356290 is not found in API Server
2025-08-11 02:37:12,790 - DEBUG - VN ctest-VN2-13356290 is not present in Agent 10.0.0.57
2025-08-11 02:37:12,801 - DEBUG - VN ctest-VN2-13356290 is not present in Agent 10.0.0.65
2025-08-11 02:37:12,801 - INFO - Validated that VN ctest-VN2-13356290 is not in any agent
2025-08-11 02:37:12,855 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-VN2-13356290 info
2025-08-11 02:37:12,855 - INFO - Deleting VN ctest-VN1-91708207
2025-08-11 02:37:13,041 - DEBUG - Response for deleting network ()
2025-08-11 02:37:13,042 - DEBUG - Requesting: http://10.0.0.23:8082/routing-instance/103bd1cc-edb8-47f5-9ffe-ab6b32dbffc6
2025-08-11 02:37:13,056 - DEBUG - Response Code: 404
2025-08-11 02:37:13,057 - DEBUG - Requesting: http://10.0.0.23:8082/domains
2025-08-11 02:37:13,068 - DEBUG - Requesting: http://10.0.0.23:8082/domain/e652ea40-e608-445e-8759-8973ddbd3f22
2025-08-11 02:37:13,083 - DEBUG - Requesting: http://10.0.0.23:8082/project/be7cfb39-02ce-4e5d-9791-37da70fd6cfe
2025-08-11 02:37:13,186 - INFO - Validated that VN ctest-VN1-91708207 is not found in API Server
2025-08-11 02:37:13,197 - DEBUG - VN ctest-VN1-91708207 is not present in Agent 10.0.0.57
2025-08-11 02:37:13,214 - DEBUG - VN ctest-VN1-91708207 is not present in Agent 10.0.0.65
2025-08-11 02:37:13,214 - INFO - Validated that VN ctest-VN1-91708207 is not in any agent
2025-08-11 02:37:13,250 - INFO - Validated that Routing instances and Config db in Control-nodes does not have VN ctest-VN1-91708207 info
2025-08-11 02:37:13,351 - INFO - IPAM: ipam3 is not found in API Server
2025-08-11 02:37:13,373 - INFO - IPAM:ipam3 is not found in control node
2025-08-11 02:37:13,527 - INFO - IPAM: ipam2 is not found in API Server
2025-08-11 02:37:13,552 - INFO - IPAM:ipam2 is not found in control node
2025-08-11 02:37:13,695 - INFO - IPAM: ipam1 is not found in API Server
2025-08-11 02:37:13,717 - INFO - IPAM:ipam1 is not found in control node
2025-08-11 02:37:14,981 - DEBUG - No XMPP flaps were noticed during the test
2025-08-11 02:37:14,981 - INFO -
2025-08-11 02:37:14,981 - INFO - END TEST : test_policy_inheritance_src_vn_dst_pol : SKIPPED[0:00:11]
2025-08-11 02:37:14,981 - INFO - --------------------------------------------------------------------------------
2025-08-11 02:37:15,717 - INFO - Deleted project: ctest-TestPolicyAcl-44915902, ID : be7cfb39-02ce-4e5d-9791-37da70fd6cfe