2026-05-12 13:18:56,719 - INFO - Domain Default found not creating
2026-05-12 13:18:56,978 - INFO - Project ctest-TestPorts-78347917 not found, creating it
2026-05-12 13:18:57,520 - INFO - Created Project:ctest-TestPorts-78347917, ID : f820cc57-cd81-4636-9ceb-3e9bb3250145
2026-05-12 13:18:59,306 - INFO - ================================================================================
2026-05-12 13:18:59,307 - INFO - STARTING TEST : test_ports_bindings
2026-05-12 13:18:59,307 - 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-05-12 13:18:59,581 - DEBUG - Nothing to compare xmpp stats {'10.0.0.22': {'10.20.0.17': '0'}} with
2026-05-12 13:18:59,581 - INFO - Initial checks done. Running the testcase now
2026-05-12 13:18:59,581 - INFO -
2026-05-12 13:19:00,304 - DEBUG - Response for create_network : {'network': {'id': '3b2672ac-7f9d-4ef6-9382-4406692c54f7', 'name': 'ctest-vn-91040737', 'tenant_id': 'f820cc57cd8146369ceb3e9bb3250145', 'project_id': 'f820cc57cd8146369ceb3e9bb3250145', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestPorts-78347917', 'ctest-vn-91040737'], 'port_security_enabled': True, 'description': ''}}
2026-05-12 13:19:00,579 - DEBUG - Response for create_subnet : {'subnet': {'id': '4183b008-5962-4cd5-8906-16faccefb5d2', 'name': '', 'tenant_id': 'f820cc57cd8146369ceb3e9bb3250145', 'network_id': '3b2672ac-7f9d-4ef6-9382-4406692c54f7', 'ip_version': 4, 'cidr': '141.20.16.0/26', 'allocation_pools': [{'start': '141.20.16.2', 'end': '141.20.16.62'}], 'gateway_ip': '141.20.16.1', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '141.20.16.2', 'tags': [], 'project_id': 'f820cc57cd8146369ceb3e9bb3250145'}}
2026-05-12 13:19:00,607 - INFO - Created VN ctest-vn-91040737
2026-05-12 13:19:00,662 - DEBUG - VN ctest-vn-91040737 UUID is 3b2672ac-7f9d-4ef6-9382-4406692c54f7
2026-05-12 13:19:00,796 - DEBUG - Read virtual machine interface {'fq_name': ['default-domain', 'ctest-TestPorts-78347917', 'ctest-vmi-74039681']}
2026-05-12 13:19:01,162 - DEBUG - Response for create_port : {'port': {'name': 'ctest-vmi-74039681', 'id': '67f21437-0151-484c-8b2c-1a3cbb930d63', 'tenant_id': 'f820cc57cd8146369ceb3e9bb3250145', 'network_id': '3b2672ac-7f9d-4ef6-9382-4406692c54f7', 'mac_address': '02:67:f2:14:37:01', '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': '141.20.16.3', 'subnet_id': '4183b008-5962-4cd5-8906-16faccefb5d2'}], 'security_groups': ['0bcd3122-4604-48c3-8290-d282d95759b8'], 'admin_state_up': True, 'device_id': '', 'device_owner': '', 'status': 'DOWN', 'port_security_enabled': True, 'description': '', 'project_id': 'f820cc57cd8146369ceb3e9bb3250145'}}
2026-05-12 13:19:01,162 - DEBUG - Created port 67f21437-0151-484c-8b2c-1a3cbb930d63
2026-05-12 13:19:01,283 - DEBUG - Requesting: http://10.0.0.22:8082/virtual-machine-interface/67f21437-0151-484c-8b2c-1a3cbb930d63
2026-05-12 13:19:01,600 - DEBUG - Requesting: http://10.0.0.22:8082/virtual-machine-interface/67f21437-0151-484c-8b2c-1a3cbb930d63
2026-05-12 13:19:01,650 - INFO - VMI 67f21437-0151-484c-8b2c-1a3cbb930d63 verification in API Server passed
2026-05-12 13:19:01,784 - DEBUG - Response for delete_port : ()
2026-05-12 13:19:01,784 - INFO - Deleted port 67f21437-0151-484c-8b2c-1a3cbb930d63
2026-05-12 13:19:01,785 - INFO - Deleting VN ctest-vn-91040737
2026-05-12 13:19:01,931 - DEBUG - Response for deleting network ()
2026-05-12 13:19:02,210 - DEBUG - No XMPP flaps were noticed during the test
2026-05-12 13:19:02,210 - INFO - END TEST : test_ports_bindings : PASSED[0:00:03]
2026-05-12 13:19:02,210 - INFO - --------------------------------------------------------------------------------
2026-05-12 13:19:02,213 - INFO - ================================================================================
2026-05-12 13:19:02,214 - INFO - STARTING TEST : test_ports_specific_subnet_ip
2026-05-12 13:19:02,214 - 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-05-12 13:19:02,509 - DEBUG - Nothing to compare xmpp stats {'10.0.0.22': {'10.20.0.17': '0'}} with
2026-05-12 13:19:02,509 - INFO - Initial checks done. Running the testcase now
2026-05-12 13:19:02,509 - INFO -
2026-05-12 13:19:02,759 - DEBUG - Response for create_network : {'network': {'id': '7dccdb45-a872-40f4-9334-113e800fdf9b', 'name': 'ctest-vn1-58006975', 'tenant_id': 'f820cc57cd8146369ceb3e9bb3250145', 'project_id': 'f820cc57cd8146369ceb3e9bb3250145', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestPorts-78347917', 'ctest-vn1-58006975'], 'port_security_enabled': True, 'description': ''}}
2026-05-12 13:19:02,943 - DEBUG - Response for create_subnet : {'subnet': {'id': '87d8fcb7-7eb7-4e2a-87d2-f2e2ba78503e', 'name': '', 'tenant_id': 'f820cc57cd8146369ceb3e9bb3250145', 'network_id': '7dccdb45-a872-40f4-9334-113e800fdf9b', 'ip_version': 4, 'cidr': '64.231.113.192/26', 'allocation_pools': [{'start': '64.231.113.194', 'end': '64.231.113.254'}], 'gateway_ip': '64.231.113.193', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '64.231.113.194', 'tags': [], 'project_id': 'f820cc57cd8146369ceb3e9bb3250145'}}
2026-05-12 13:19:03,124 - DEBUG - Response for create_subnet : {'subnet': {'id': 'dc22af26-0c77-4b01-bcec-c7c428f854b6', 'name': '', 'tenant_id': 'f820cc57cd8146369ceb3e9bb3250145', 'network_id': '7dccdb45-a872-40f4-9334-113e800fdf9b', 'ip_version': 4, 'cidr': '30.236.212.0/26', 'allocation_pools': [{'start': '30.236.212.2', 'end': '30.236.212.62'}], 'gateway_ip': '30.236.212.1', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '30.236.212.2', 'tags': [], 'project_id': 'f820cc57cd8146369ceb3e9bb3250145'}}
2026-05-12 13:19:03,157 - INFO - Created VN ctest-vn1-58006975
2026-05-12 13:19:03,214 - DEBUG - VN ctest-vn1-58006975 UUID is 7dccdb45-a872-40f4-9334-113e800fdf9b
2026-05-12 13:19:03,614 - DEBUG - Response for create_port : {'port': {'name': 'ab7bc0a1-c0b4-4655-bdb9-1dff54e6bb0f', 'id': 'ab7bc0a1-c0b4-4655-bdb9-1dff54e6bb0f', 'tenant_id': 'f820cc57cd8146369ceb3e9bb3250145', 'network_id': '7dccdb45-a872-40f4-9334-113e800fdf9b', 'mac_address': '02:ab:7b:c0:a1:c0', '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': '64.231.113.197', 'subnet_id': '87d8fcb7-7eb7-4e2a-87d2-f2e2ba78503e'}], 'security_groups': ['0bcd3122-4604-48c3-8290-d282d95759b8'], 'admin_state_up': True, 'device_id': '', 'device_owner': '', 'status': 'DOWN', 'port_security_enabled': True, 'description': '', 'project_id': 'f820cc57cd8146369ceb3e9bb3250145'}}
2026-05-12 13:19:03,837 - DEBUG - Response for create_port : {'port': {'name': '175df6e4-1520-46f9-ba37-1a8e8e649972', 'id': '175df6e4-1520-46f9-ba37-1a8e8e649972', 'tenant_id': 'f820cc57cd8146369ceb3e9bb3250145', 'network_id': '7dccdb45-a872-40f4-9334-113e800fdf9b', 'mac_address': '02:17:5d:f6:e4:15', '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': '30.236.212.5', 'subnet_id': 'dc22af26-0c77-4b01-bcec-c7c428f854b6'}], 'security_groups': ['0bcd3122-4604-48c3-8290-d282d95759b8'], 'admin_state_up': True, 'device_id': '', 'device_owner': '', 'status': 'DOWN', 'port_security_enabled': True, 'description': '', 'project_id': 'f820cc57cd8146369ceb3e9bb3250145'}}
2026-05-12 13:19:03,921 - DEBUG - Services list from nova: [, , ]
2026-05-12 13:19:04,447 - INFO - VM ([]) created on node: (cn-jenkins-deploy-platform-ansible-os-5771-1), Zone: (nova:cn-jenkins-deploy-platform-ansible-os-5771-1)
2026-05-12 13:19:05,036 - INFO - VM ([]) created on node: (cn-jenkins-deploy-platform-ansible-os-5771-1), Zone: (nova:cn-jenkins-deploy-platform-ansible-os-5771-1)
2026-05-12 13:19:05,037 - INFO - Waiting for VM ctest-vn1-vm1-36492042 to be up..
2026-05-12 13:19:05,098 - DEBUG - VM is still in BUILD state, Expected: ACTIVE
2026-05-12 13:19:10,236 - DEBUG - VM is in ACTIVE state now
2026-05-12 13:19:10,237 - INFO - VM name : ctest-vn1-vm1-36492042
2026-05-12 13:19:10,393 - DEBUG - VM ctest-vn1-vm1-36492042 ID is 4d4014f0-2dc0-4373-a152-5b2379d92ed8
2026-05-12 13:19:10,421 - DEBUG - VM ctest-vn1-vm1-36492042 launched on Node cn-jenkins-deploy-platform-ansible-os-5771-1
2026-05-12 13:19:10,620 - DEBUG - Requesting: http://10.0.0.22:8082/virtual-machine/4d4014f0-2dc0-4373-a152-5b2379d92ed8
2026-05-12 13:19:10,666 - DEBUG - Requesting: http://10.0.0.22:8082/virtual-machine-interface/ab7bc0a1-c0b4-4655-bdb9-1dff54e6bb0f
2026-05-12 13:19:13,982 - 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 1001ms')
2026-05-12 13:19:13,982 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-vn1-vm1-36492042 failed!
2026-05-12 13:19:14,067 - DEBUG - Gateway for vn default-domain:ctest-TestPorts-78347917:ctest-vn1-58006975 is 64.231.113.193 and allocation pool is NOT set
2026-05-12 13:19:14,067 - DEBUG - Gateway for vn default-domain:ctest-TestPorts-78347917:ctest-vn1-58006975 is 30.236.212.1 and allocation pool is NOT set
2026-05-12 13:19:18,141 - 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 1010ms')
2026-05-12 13:19:18,141 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-vn1-vm1-36492042 failed!
2026-05-12 13:19:18,202 - DEBUG - Gateway for vn default-domain:ctest-TestPorts-78347917:ctest-vn1-58006975 is 64.231.113.193 and allocation pool is NOT set
2026-05-12 13:19:18,203 - DEBUG - Gateway for vn default-domain:ctest-TestPorts-78347917:ctest-vn1-58006975 is 30.236.212.1 and allocation pool is NOT set
2026-05-12 13:19:20,267 - 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=1 ttl=63 time=3.76 ms\r\n64 bytes from 169.254.0.3: icmp_seq=2 ttl=63 time=0.603 ms\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1002ms\r\nrtt min/avg/max/mdev = 0.603/2.181/3.759/1.578 ms')
2026-05-12 13:19:20,267 - INFO - Ping to Metadata IP 169.254.0.3 of VM ctest-vn1-vm1-36492042 passed
2026-05-12 13:19:20,422 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2026-05-12 13:19:20,422 - DEBUG - Waiting to SSH to VM ctest-vn1-vm1-36492042, IP 64.231.113.197, Port 22
2026-05-12 13:19:20,596 - DEBUG - VM ctest-vn1-vm1-36492042 is ready for SSH connections
2026-05-12 13:19:20,597 - INFO - Waiting for VM ctest-vn1-vm2-25110581 to be up..
2026-05-12 13:19:20,708 - DEBUG - VM is in ACTIVE state now
2026-05-12 13:19:20,708 - INFO - VM name : ctest-vn1-vm2-25110581
2026-05-12 13:19:20,817 - DEBUG - VM ctest-vn1-vm2-25110581 ID is faca3c2d-fb21-4e0c-b578-7512c21e00ac
2026-05-12 13:19:20,817 - DEBUG - VM ctest-vn1-vm2-25110581 launched on Node cn-jenkins-deploy-platform-ansible-os-5771-1
2026-05-12 13:19:20,923 - DEBUG - Requesting: http://10.0.0.22:8082/virtual-machine/faca3c2d-fb21-4e0c-b578-7512c21e00ac
2026-05-12 13:19:20,936 - DEBUG - Requesting: http://10.0.0.22:8082/virtual-machine-interface/175df6e4-1520-46f9-ba37-1a8e8e649972
2026-05-12 13:19:22,214 - 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=7.82 ms\r\n64 bytes from 169.254.0.4: icmp_seq=2 ttl=63 time=0.837 ms\r\n\r\n--- 169.254.0.4 ping statistics ---\r\n2 packets transmitted, 2 received, 0% packet loss, time 1002ms\r\nrtt min/avg/max/mdev = 0.837/4.330/7.824/3.493 ms')
2026-05-12 13:19:22,214 - INFO - Ping to Metadata IP 169.254.0.4 of VM ctest-vn1-vm2-25110581 passed
2026-05-12 13:19:22,370 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2026-05-12 13:19:22,370 - DEBUG - Waiting to SSH to VM ctest-vn1-vm2-25110581, IP 30.236.212.5, Port 22
2026-05-12 13:19:22,537 - DEBUG - VM ctest-vn1-vm2-25110581 is ready for SSH connections
2026-05-12 13:19:22,537 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2026-05-12 13:19:22,537 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2026-05-12 13:19:22,537 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2026-05-12 13:19:22,537 - DEBUG - Running remote_cmd, Cmd : ping -s 56 -c 3 -W 1 64.231.113.197, host_string: cirros@169.254.0.4, password: cubswin:)gateway: ubuntu@10.0.0.22, gateway password: c0ntrail123
2026-05-12 13:19:22,537 - DEBUG - ping -s 56 -c 3 -W 1 64.231.113.197
2026-05-12 13:19:25,304 - DEBUG - PING 64.231.113.197 (64.231.113.197): 56 data bytes
64 bytes from 64.231.113.197: seq=0 ttl=63 time=6.469 ms
64 bytes from 64.231.113.197: seq=1 ttl=63 time=1.396 ms
64 bytes from 64.231.113.197: seq=2 ttl=63 time=1.218 ms
--- 64.231.113.197 ping statistics ---
3 packets transmitted, 3 packets received, 0% packet loss
round-trip min/avg/max = 1.218/3.027/6.469 ms
2026-05-12 13:19:25,304 - INFO - Ping to IP 64.231.113.197 from VM ctest-vn1-vm2-25110581 passed
2026-05-12 13:19:25,304 - INFO - Detaching port 175df6e4-1520-46f9-ba37-1a8e8e649972 from VM ctest-vn1-vm2-25110581
2026-05-12 13:19:25,374 - INFO - Deleting VM ctest-vn1-vm2-25110581
2026-05-12 13:19:25,476 - INFO - Detaching port ab7bc0a1-c0b4-4655-bdb9-1dff54e6bb0f from VM ctest-vn1-vm1-36492042
2026-05-12 13:19:25,529 - INFO - Deleting VM ctest-vn1-vm1-36492042
2026-05-12 13:19:25,861 - DEBUG - Response for delete_port : ()
2026-05-12 13:19:26,148 - DEBUG - Response for delete_port : ()
2026-05-12 13:19:26,149 - INFO - Deleting VN ctest-vn1-58006975
2026-05-12 13:19:26,345 - DEBUG - Response for deleting network ()
2026-05-12 13:19:26,624 - DEBUG - No XMPP flaps were noticed during the test
2026-05-12 13:19:26,624 - INFO - END TEST : test_ports_specific_subnet_ip : PASSED[0:00:24]
2026-05-12 13:19:26,624 - INFO - --------------------------------------------------------------------------------
2026-05-12 13:19:27,493 - INFO - Deleted project: ctest-TestPorts-78347917, ID : f820cc57-cd81-4636-9ceb-3e9bb3250145