2026-02-10 11:30:55,608 - INFO - Domain Default found not creating 2026-02-10 11:30:55,810 - INFO - Project ctest-TestPorts-53844369 not found, creating it 2026-02-10 11:30:56,499 - INFO - Created Project:ctest-TestPorts-53844369, ID : 5e3d78bf-1eaa-49dd-93ae-c4ff97e29228 2026-02-10 11:30:59,278 - INFO - ================================================================================ 2026-02-10 11:30:59,278 - INFO - STARTING TEST : test_ports_bindings 2026-02-10 11:30:59,279 - INFO - TEST DESCRIPTION : Verify that we are able to create a port with custom port bindings Steps: 1) Create Port with Port bindings profile set to {'foo': 'bar'} 2) Retrieve and verify the same is set 2026-02-10 11:30:59,592 - DEBUG - Nothing to compare xmpp stats {'10.0.0.50': {'10.20.0.17': '0'}} with 2026-02-10 11:30:59,592 - INFO - Initial checks done. Running the testcase now 2026-02-10 11:30:59,592 - INFO - 2026-02-10 11:31:00,275 - DEBUG - Response for create_network : {'network': {'id': '7c7adb8f-cba6-48d9-aac0-0b1916f895c0', 'name': 'ctest-vn-68532765', 'tenant_id': '5e3d78bf1eaa49dd93aec4ff97e29228', 'project_id': '5e3d78bf1eaa49dd93aec4ff97e29228', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestPorts-53844369', 'ctest-vn-68532765'], 'port_security_enabled': True, 'description': ''}} 2026-02-10 11:31:00,467 - DEBUG - Response for create_subnet : {'subnet': {'id': '5a75c8fd-8090-4e92-8a59-0f8a36c86252', 'name': '', 'tenant_id': '5e3d78bf1eaa49dd93aec4ff97e29228', 'network_id': '7c7adb8f-cba6-48d9-aac0-0b1916f895c0', 'ip_version': 4, 'cidr': '50.28.48.192/26', 'allocation_pools': [{'start': '50.28.48.194', 'end': '50.28.48.254'}], 'gateway_ip': '50.28.48.193', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '50.28.48.194', 'tags': [], 'project_id': '5e3d78bf1eaa49dd93aec4ff97e29228'}} 2026-02-10 11:31:00,487 - INFO - Created VN ctest-vn-68532765 2026-02-10 11:31:00,543 - DEBUG - VN ctest-vn-68532765 UUID is 7c7adb8f-cba6-48d9-aac0-0b1916f895c0 2026-02-10 11:31:00,668 - DEBUG - Read virtual machine interface {'fq_name': ['default-domain', 'ctest-TestPorts-53844369', 'ctest-vmi-30816407']} 2026-02-10 11:31:00,974 - DEBUG - Response for create_port : {'port': {'name': 'ctest-vmi-30816407', 'id': 'ef516dda-7221-403f-b3fd-40c94c950416', 'tenant_id': '5e3d78bf1eaa49dd93aec4ff97e29228', 'network_id': '7c7adb8f-cba6-48d9-aac0-0b1916f895c0', 'mac_address': '02:ef:51:6d:da:72', 'binding:profile': {'foo': 'bar'}, 'binding:vnic_type': 'normal', 'binding:vif_details': {'port_filter': True}, 'binding:vif_type': 'unbound', 'binding:host_id': None, 'allowed_address_pairs': [], 'fixed_ips': [{'ip_address': '50.28.48.195', 'subnet_id': '5a75c8fd-8090-4e92-8a59-0f8a36c86252'}], 'security_groups': ['f002863d-0c7b-42da-b310-d3631b48324a'], 'admin_state_up': True, 'device_id': '', 'device_owner': '', 'status': 'DOWN', 'port_security_enabled': True, 'description': '', 'project_id': '5e3d78bf1eaa49dd93aec4ff97e29228'}} 2026-02-10 11:31:00,974 - DEBUG - Created port ef516dda-7221-403f-b3fd-40c94c950416 2026-02-10 11:31:01,088 - DEBUG - Requesting: http://10.0.0.50:8082/virtual-machine-interface/ef516dda-7221-403f-b3fd-40c94c950416 2026-02-10 11:31:01,426 - DEBUG - Requesting: http://10.0.0.50:8082/virtual-machine-interface/ef516dda-7221-403f-b3fd-40c94c950416 2026-02-10 11:31:01,469 - INFO - VMI ef516dda-7221-403f-b3fd-40c94c950416 verification in API Server passed 2026-02-10 11:31:01,592 - DEBUG - Response for delete_port : () 2026-02-10 11:31:01,592 - INFO - Deleted port ef516dda-7221-403f-b3fd-40c94c950416 2026-02-10 11:31:01,593 - INFO - Deleting VN ctest-vn-68532765 2026-02-10 11:31:01,696 - DEBUG - Response for deleting network () 2026-02-10 11:31:01,966 - DEBUG - No XMPP flaps were noticed during the test
2026-02-10 11:31:01,967 - INFO - END TEST : test_ports_bindings : PASSED[0:00:02]
2026-02-10 11:31:01,967 - INFO - -------------------------------------------------------------------------------- 2026-02-10 11:31:01,975 - INFO - ================================================================================ 2026-02-10 11:31:01,975 - INFO - STARTING TEST : test_ports_specific_subnet_ip 2026-02-10 11:31:01,976 - INFO - TEST DESCRIPTION : Create ports with specific Subnet and IP Create two ports in a VN with 2 subnets and specific IPs Attach to two VMs Ping between them should pass 2026-02-10 11:31:02,276 - DEBUG - Nothing to compare xmpp stats {'10.0.0.50': {'10.20.0.17': '0'}} with 2026-02-10 11:31:02,276 - INFO - Initial checks done. Running the testcase now 2026-02-10 11:31:02,276 - INFO - 2026-02-10 11:31:02,492 - DEBUG - Response for create_network : {'network': {'id': '14965c6f-697f-4658-bfe0-77ffa31bc2f5', 'name': 'ctest-vn1-05797696', 'tenant_id': '5e3d78bf1eaa49dd93aec4ff97e29228', 'project_id': '5e3d78bf1eaa49dd93aec4ff97e29228', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestPorts-53844369', 'ctest-vn1-05797696'], 'port_security_enabled': True, 'description': ''}} 2026-02-10 11:31:02,651 - DEBUG - Response for create_subnet : {'subnet': {'id': '34c3893a-dfb2-4519-b210-9cda1110e38b', 'name': '', 'tenant_id': '5e3d78bf1eaa49dd93aec4ff97e29228', 'network_id': '14965c6f-697f-4658-bfe0-77ffa31bc2f5', 'ip_version': 4, 'cidr': '221.47.166.192/26', 'allocation_pools': [{'start': '221.47.166.194', 'end': '221.47.166.254'}], 'gateway_ip': '221.47.166.193', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '221.47.166.194', 'tags': [], 'project_id': '5e3d78bf1eaa49dd93aec4ff97e29228'}} 2026-02-10 11:31:02,913 - DEBUG - Response for create_subnet : {'subnet': {'id': 'abc70485-1eaf-43ee-b934-9f90dd871523', 'name': '', 'tenant_id': '5e3d78bf1eaa49dd93aec4ff97e29228', 'network_id': '14965c6f-697f-4658-bfe0-77ffa31bc2f5', 'ip_version': 4, 'cidr': '4.174.224.128/26', 'allocation_pools': [{'start': '4.174.224.130', 'end': '4.174.224.190'}], 'gateway_ip': '4.174.224.129', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '4.174.224.130', 'tags': [], 'project_id': '5e3d78bf1eaa49dd93aec4ff97e29228'}} 2026-02-10 11:31:02,937 - INFO - Created VN ctest-vn1-05797696 2026-02-10 11:31:02,992 - DEBUG - VN ctest-vn1-05797696 UUID is 14965c6f-697f-4658-bfe0-77ffa31bc2f5 2026-02-10 11:31:03,426 - DEBUG - Response for create_port : {'port': {'name': 'db5ac0c1-4911-471b-9738-675bd308ee69', 'id': 'db5ac0c1-4911-471b-9738-675bd308ee69', 'tenant_id': '5e3d78bf1eaa49dd93aec4ff97e29228', 'network_id': '14965c6f-697f-4658-bfe0-77ffa31bc2f5', 'mac_address': '02:db:5a:c0:c1:49', 'binding:vnic_type': 'normal', 'binding:vif_details': {'port_filter': True}, 'binding:vif_type': 'unbound', 'binding:host_id': None, 'allowed_address_pairs': [], 'fixed_ips': [{'ip_address': '221.47.166.197', 'subnet_id': '34c3893a-dfb2-4519-b210-9cda1110e38b'}], 'security_groups': ['f002863d-0c7b-42da-b310-d3631b48324a'], 'admin_state_up': True, 'device_id': '', 'device_owner': '', 'status': 'DOWN', 'port_security_enabled': True, 'description': '', 'project_id': '5e3d78bf1eaa49dd93aec4ff97e29228'}} 2026-02-10 11:31:03,626 - DEBUG - Response for create_port : {'port': {'name': '9900cc39-b332-4c97-b2f4-fc504f78f819', 'id': '9900cc39-b332-4c97-b2f4-fc504f78f819', 'tenant_id': '5e3d78bf1eaa49dd93aec4ff97e29228', 'network_id': '14965c6f-697f-4658-bfe0-77ffa31bc2f5', 'mac_address': '02:99:00:cc:39:b3', 'binding:vnic_type': 'normal', 'binding:vif_details': {'port_filter': True}, 'binding:vif_type': 'unbound', 'binding:host_id': None, 'allowed_address_pairs': [], 'fixed_ips': [{'ip_address': '4.174.224.133', 'subnet_id': 'abc70485-1eaf-43ee-b934-9f90dd871523'}], 'security_groups': ['f002863d-0c7b-42da-b310-d3631b48324a'], 'admin_state_up': True, 'device_id': '', 'device_owner': '', 'status': 'DOWN', 'port_security_enabled': True, 'description': '', 'project_id': '5e3d78bf1eaa49dd93aec4ff97e29228'}} 2026-02-10 11:31:03,703 - DEBUG - Services list from nova: [, , ] 2026-02-10 11:31:04,248 - INFO - VM ([]) created on node: (cn-jenkins-deploy-platform-ansible-os-5265-1), Zone: (nova:cn-jenkins-deploy-platform-ansible-os-5265-1) 2026-02-10 11:31:04,830 - INFO - VM ([]) created on node: (cn-jenkins-deploy-platform-ansible-os-5265-1), Zone: (nova:cn-jenkins-deploy-platform-ansible-os-5265-1) 2026-02-10 11:31:04,831 - INFO - Waiting for VM ctest-vn1-vm1-02574685 to be up.. 2026-02-10 11:31:04,875 - DEBUG - VM is still in BUILD state, Expected: ACTIVE 2026-02-10 11:31:09,961 - DEBUG - VM is in ACTIVE state now 2026-02-10 11:31:09,961 - INFO - VM name : ctest-vn1-vm1-02574685 2026-02-10 11:31:10,089 - DEBUG - VM ctest-vn1-vm1-02574685 ID is c89fd8d6-e24e-4a4c-8068-6e71fba26e41 2026-02-10 11:31:10,126 - DEBUG - VM ctest-vn1-vm1-02574685 launched on Node cn-jenkins-deploy-platform-ansible-os-5265-1 2026-02-10 11:31:10,244 - DEBUG - Requesting: http://10.0.0.50:8082/virtual-machine/c89fd8d6-e24e-4a4c-8068-6e71fba26e41 2026-02-10 11:31:10,258 - DEBUG - Requesting: http://10.0.0.50:8082/virtual-machine-interface/db5ac0c1-4911-471b-9738-675bd308ee69 2026-02-10 11:31:13,542 - DEBUG - (True, 'PING 169.254.0.3 (169.254.0.3) 56(84) bytes of data.\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 0 received, 100% packet loss, time 1015ms') 2026-02-10 11:31:13,542 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-vn1-vm1-02574685 failed! 2026-02-10 11:31:13,607 - DEBUG - Gateway for vn default-domain:ctest-TestPorts-53844369:ctest-vn1-05797696 is 221.47.166.193 and allocation pool is NOT set 2026-02-10 11:31:13,607 - DEBUG - Gateway for vn default-domain:ctest-TestPorts-53844369:ctest-vn1-05797696 is 4.174.224.129 and allocation pool is NOT set 2026-02-10 11:31:17,693 - DEBUG - (True, 'PING 169.254.0.3 (169.254.0.3) 56(84) bytes of data.\r\n64 bytes from 169.254.0.3: icmp_seq=2 ttl=63 time=13.7 ms\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 1 received, 50% packet loss, time 1017ms\r\nrtt min/avg/max/mdev = 13.670/13.670/13.670/0.000 ms') 2026-02-10 11:31:17,694 - INFO - Ping to Metadata IP 169.254.0.3 of VM ctest-vn1-vm1-02574685 passed 2026-02-10 11:31:17,864 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-10 11:31:17,864 - DEBUG - Waiting to SSH to VM ctest-vn1-vm1-02574685, IP 221.47.166.197, Port 22 2026-02-10 11:31:17,944 - DEBUG - Error on ssh to cirros@169.254.0.3:22, result: /bin/bash: connect: Connection refused /bin/bash: line 1: /dev/tcp/169.254.0.3/22: Connection refused {'failed': True, 'command': '(echo > /dev/tcp/169.254.0.3/22)', 'real_command': '/bin/bash -l -c "(echo > /dev/tcp/169.254.0.3/22)"', 'return_code': 1, 'succeeded': False, 'stderr': ''} 2026-02-10 11:31:18,091 - DEBUG - VM ctest-vn1-vm1-02574685 is NOT ready for SSH connections, VM status: ACTIVE 2026-02-10 11:31:23,092 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-10 11:31:23,092 - DEBUG - Waiting to SSH to VM ctest-vn1-vm1-02574685, IP 221.47.166.197, Port 22 2026-02-10 11:31:23,293 - DEBUG - VM ctest-vn1-vm1-02574685 is ready for SSH connections 2026-02-10 11:31:23,293 - INFO - Waiting for VM ctest-vn1-vm2-74754611 to be up.. 2026-02-10 11:31:23,443 - DEBUG - VM is in ACTIVE state now 2026-02-10 11:31:23,443 - INFO - VM name : ctest-vn1-vm2-74754611 2026-02-10 11:31:23,562 - DEBUG - VM ctest-vn1-vm2-74754611 ID is 73ee8be9-4cf9-4866-bfcc-04a820e06273 2026-02-10 11:31:23,562 - DEBUG - VM ctest-vn1-vm2-74754611 launched on Node cn-jenkins-deploy-platform-ansible-os-5265-1 2026-02-10 11:31:23,680 - DEBUG - Requesting: http://10.0.0.50:8082/virtual-machine/73ee8be9-4cf9-4866-bfcc-04a820e06273 2026-02-10 11:31:23,691 - DEBUG - Requesting: http://10.0.0.50:8082/virtual-machine-interface/9900cc39-b332-4c97-b2f4-fc504f78f819 2026-02-10 11:31:24,974 - DEBUG - (True, 'PING 169.254.0.4 (169.254.0.4) 56(84) bytes of data.\r\n64 bytes from 169.254.0.4: icmp_seq=1 ttl=63 time=5.90 ms\r\n64 bytes from 169.254.0.4: icmp_seq=2 ttl=63 time=0.622 ms\r\n\r\n--- 169.254.0.4 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1001ms\r\nrtt min/avg/max/mdev = 0.622/3.262/5.902/2.640 ms') 2026-02-10 11:31:24,975 - INFO - Ping to Metadata IP 169.254.0.4 of VM ctest-vn1-vm2-74754611 passed 2026-02-10 11:31:25,151 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-10 11:31:25,152 - DEBUG - Waiting to SSH to VM ctest-vn1-vm2-74754611, IP 4.174.224.133, Port 22 2026-02-10 11:31:25,348 - DEBUG - VM ctest-vn1-vm2-74754611 is ready for SSH connections 2026-02-10 11:31:25,349 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-10 11:31:25,349 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-10 11:31:25,349 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set 2026-02-10 11:31:25,349 - DEBUG - Running remote_cmd, Cmd : ping -s 56 -c 3 -W 1 221.47.166.197, host_string: cirros@169.254.0.4, password: cubswin:)gateway: ubuntu@10.0.0.50, gateway password: c0ntrail123 2026-02-10 11:31:25,350 - DEBUG - ping -s 56 -c 3 -W 1 221.47.166.197 2026-02-10 11:31:28,156 - DEBUG - PING 221.47.166.197 (221.47.166.197): 56 data bytes 64 bytes from 221.47.166.197: seq=0 ttl=63 time=4.064 ms 64 bytes from 221.47.166.197: seq=1 ttl=63 time=1.459 ms 64 bytes from 221.47.166.197: seq=2 ttl=63 time=1.294 ms --- 221.47.166.197 ping statistics --- 3 packets transmitted, 3 packets received, 0% packet loss round-trip min/avg/max = 1.294/2.272/4.064 ms 2026-02-10 11:31:28,157 - INFO - Ping to IP 221.47.166.197 from VM ctest-vn1-vm2-74754611 passed 2026-02-10 11:31:28,157 - INFO - Detaching port 9900cc39-b332-4c97-b2f4-fc504f78f819 from VM ctest-vn1-vm2-74754611 2026-02-10 11:31:28,252 - INFO - Deleting VM ctest-vn1-vm2-74754611 2026-02-10 11:31:28,371 - INFO - Detaching port db5ac0c1-4911-471b-9738-675bd308ee69 from VM ctest-vn1-vm1-02574685 2026-02-10 11:31:28,425 - INFO - Deleting VM ctest-vn1-vm1-02574685 2026-02-10 11:31:28,684 - DEBUG - Response for delete_port : () 2026-02-10 11:31:28,870 - DEBUG - Response for delete_port : () 2026-02-10 11:31:28,870 - INFO - Deleting VN ctest-vn1-05797696 2026-02-10 11:31:29,005 - DEBUG - Response for deleting network () 2026-02-10 11:31:29,268 - DEBUG - No XMPP flaps were noticed during the test
2026-02-10 11:31:29,268 - INFO - END TEST : test_ports_specific_subnet_ip : PASSED[0:00:28]
2026-02-10 11:31:29,268 - INFO - -------------------------------------------------------------------------------- 2026-02-10 11:31:30,045 - INFO - Deleted project: ctest-TestPorts-53844369, ID : 5e3d78bf-1eaa-49dd-93ae-c4ff97e29228