2026-02-12 12:22:37,156 - INFO - Domain Default found not creating
2026-02-12 12:22:37,376 - INFO - Project ctest-TestPorts-98913602 not found, creating it
2026-02-12 12:22:37,968 - INFO - Created Project:ctest-TestPorts-98913602, ID : 60b72183-1ea8-406f-b9f3-b5edc8a0b92f
2026-02-12 12:22:39,831 - INFO - ================================================================================
2026-02-12 12:22:39,831 - INFO - STARTING TEST : test_ports_bindings
2026-02-12 12:22:39,831 - 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-12 12:22:40,097 - DEBUG - Nothing to compare xmpp stats {'10.0.0.73': {'10.20.0.17': '0'}} with
2026-02-12 12:22:40,097 - INFO - Initial checks done. Running the testcase now
2026-02-12 12:22:40,097 - INFO -
2026-02-12 12:22:40,760 - DEBUG - Response for create_network : {'network': {'id': 'a25ee2f9-d8cb-44ce-9aeb-fa91f1d11221', 'name': 'ctest-vn-31702715', 'tenant_id': '60b721831ea8406fb9f3b5edc8a0b92f', 'project_id': '60b721831ea8406fb9f3b5edc8a0b92f', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestPorts-98913602', 'ctest-vn-31702715'], 'port_security_enabled': True, 'description': ''}}
2026-02-12 12:22:40,990 - DEBUG - Response for create_subnet : {'subnet': {'id': 'c204037f-ee40-4d77-a346-ebd2ae43ac2b', 'name': '', 'tenant_id': '60b721831ea8406fb9f3b5edc8a0b92f', 'network_id': 'a25ee2f9-d8cb-44ce-9aeb-fa91f1d11221', 'ip_version': 4, 'cidr': '48.205.117.128/26', 'allocation_pools': [{'start': '48.205.117.130', 'end': '48.205.117.190'}], 'gateway_ip': '48.205.117.129', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '48.205.117.130', 'tags': [], 'project_id': '60b721831ea8406fb9f3b5edc8a0b92f'}}
2026-02-12 12:22:41,013 - INFO - Created VN ctest-vn-31702715
2026-02-12 12:22:41,073 - DEBUG - VN ctest-vn-31702715 UUID is a25ee2f9-d8cb-44ce-9aeb-fa91f1d11221
2026-02-12 12:22:41,199 - DEBUG - Read virtual machine interface {'fq_name': ['default-domain', 'ctest-TestPorts-98913602', 'ctest-vmi-40646490']}
2026-02-12 12:22:41,464 - DEBUG - Response for create_port : {'port': {'name': 'ctest-vmi-40646490', 'id': '1d1358cc-b4f7-4a27-99ae-c45851c93d8f', 'tenant_id': '60b721831ea8406fb9f3b5edc8a0b92f', 'network_id': 'a25ee2f9-d8cb-44ce-9aeb-fa91f1d11221', 'mac_address': '02:1d:13:58:cc:b4', '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': '48.205.117.131', 'subnet_id': 'c204037f-ee40-4d77-a346-ebd2ae43ac2b'}], 'security_groups': ['8ee24edf-c756-4d93-aa3a-cc97ec00833c'], 'admin_state_up': True, 'device_id': '', 'device_owner': '', 'status': 'DOWN', 'port_security_enabled': True, 'description': '', 'project_id': '60b721831ea8406fb9f3b5edc8a0b92f'}}
2026-02-12 12:22:41,464 - DEBUG - Created port 1d1358cc-b4f7-4a27-99ae-c45851c93d8f
2026-02-12 12:22:41,573 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine-interface/1d1358cc-b4f7-4a27-99ae-c45851c93d8f
2026-02-12 12:22:41,878 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine-interface/1d1358cc-b4f7-4a27-99ae-c45851c93d8f
2026-02-12 12:22:41,923 - INFO - VMI 1d1358cc-b4f7-4a27-99ae-c45851c93d8f verification in API Server passed
2026-02-12 12:22:42,177 - DEBUG - Response for delete_port : ()
2026-02-12 12:22:42,177 - INFO - Deleted port 1d1358cc-b4f7-4a27-99ae-c45851c93d8f
2026-02-12 12:22:42,177 - INFO - Deleting VN ctest-vn-31702715
2026-02-12 12:22:42,575 - DEBUG - Response for deleting network ()
2026-02-12 12:22:42,844 - DEBUG - No XMPP flaps were noticed during the test
2026-02-12 12:22:42,844 - INFO - END TEST : test_ports_bindings : PASSED[0:00:03]
2026-02-12 12:22:42,844 - INFO - --------------------------------------------------------------------------------
2026-02-12 12:22:42,847 - INFO - ================================================================================
2026-02-12 12:22:42,847 - INFO - STARTING TEST : test_ports_specific_subnet_ip
2026-02-12 12:22:42,847 - 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-12 12:22:43,139 - DEBUG - Nothing to compare xmpp stats {'10.0.0.73': {'10.20.0.17': '0'}} with
2026-02-12 12:22:43,139 - INFO - Initial checks done. Running the testcase now
2026-02-12 12:22:43,139 - INFO -
2026-02-12 12:22:43,366 - DEBUG - Response for create_network : {'network': {'id': '8526a12d-f277-4071-ad14-0a37e9c43e9e', 'name': 'ctest-vn1-46154740', 'tenant_id': '60b721831ea8406fb9f3b5edc8a0b92f', 'project_id': '60b721831ea8406fb9f3b5edc8a0b92f', 'admin_state_up': True, 'shared': False, 'status': 'ACTIVE', 'router:external': False, 'mtu': 0, 'subnets': [], 'fq_name': ['default-domain', 'ctest-TestPorts-98913602', 'ctest-vn1-46154740'], 'port_security_enabled': True, 'description': ''}}
2026-02-12 12:22:43,548 - DEBUG - Response for create_subnet : {'subnet': {'id': 'cb2092ba-c15c-41ec-9bc0-543311003716', 'name': '', 'tenant_id': '60b721831ea8406fb9f3b5edc8a0b92f', 'network_id': '8526a12d-f277-4071-ad14-0a37e9c43e9e', 'ip_version': 4, 'cidr': '163.81.73.64/26', 'allocation_pools': [{'start': '163.81.73.66', 'end': '163.81.73.126'}], 'gateway_ip': '163.81.73.65', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '163.81.73.66', 'tags': [], 'project_id': '60b721831ea8406fb9f3b5edc8a0b92f'}}
2026-02-12 12:22:43,764 - DEBUG - Response for create_subnet : {'subnet': {'id': '5cc98fcd-e7c2-4e20-ba85-aa0df639c768', 'name': '', 'tenant_id': '60b721831ea8406fb9f3b5edc8a0b92f', 'network_id': '8526a12d-f277-4071-ad14-0a37e9c43e9e', 'ip_version': 4, 'cidr': '60.108.128.0/26', 'allocation_pools': [{'start': '60.108.128.2', 'end': '60.108.128.62'}], 'gateway_ip': '60.108.128.1', 'enable_dhcp': True, 'ipv6_ra_mode': None, 'ipv6_address_mode': None, 'dns_nameservers': [], 'host_routes': [], 'dns_server_address': '60.108.128.2', 'tags': [], 'project_id': '60b721831ea8406fb9f3b5edc8a0b92f'}}
2026-02-12 12:22:43,788 - INFO - Created VN ctest-vn1-46154740
2026-02-12 12:22:43,841 - DEBUG - VN ctest-vn1-46154740 UUID is 8526a12d-f277-4071-ad14-0a37e9c43e9e
2026-02-12 12:22:44,185 - DEBUG - Response for create_port : {'port': {'name': '9e3dd6bf-e61a-4228-94ac-afd4b92b69ab', 'id': '9e3dd6bf-e61a-4228-94ac-afd4b92b69ab', 'tenant_id': '60b721831ea8406fb9f3b5edc8a0b92f', 'network_id': '8526a12d-f277-4071-ad14-0a37e9c43e9e', 'mac_address': '02:9e:3d:d6:bf:e6', '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': '163.81.73.69', 'subnet_id': 'cb2092ba-c15c-41ec-9bc0-543311003716'}], 'security_groups': ['8ee24edf-c756-4d93-aa3a-cc97ec00833c'], 'admin_state_up': True, 'device_id': '', 'device_owner': '', 'status': 'DOWN', 'port_security_enabled': True, 'description': '', 'project_id': '60b721831ea8406fb9f3b5edc8a0b92f'}}
2026-02-12 12:22:44,379 - DEBUG - Response for create_port : {'port': {'name': 'c8f97af8-1392-4c9d-be70-48d575fbb615', 'id': 'c8f97af8-1392-4c9d-be70-48d575fbb615', 'tenant_id': '60b721831ea8406fb9f3b5edc8a0b92f', 'network_id': '8526a12d-f277-4071-ad14-0a37e9c43e9e', 'mac_address': '02:c8:f9:7a:f8:13', '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': '60.108.128.5', 'subnet_id': '5cc98fcd-e7c2-4e20-ba85-aa0df639c768'}], 'security_groups': ['8ee24edf-c756-4d93-aa3a-cc97ec00833c'], 'admin_state_up': True, 'device_id': '', 'device_owner': '', 'status': 'DOWN', 'port_security_enabled': True, 'description': '', 'project_id': '60b721831ea8406fb9f3b5edc8a0b92f'}}
2026-02-12 12:22:44,457 - DEBUG - Services list from nova: [, , ]
2026-02-12 12:22:44,873 - INFO - VM ([]) created on node: (cn-jenkins-deploy-platform-ansible-os-5315-1), Zone: (nova:cn-jenkins-deploy-platform-ansible-os-5315-1)
2026-02-12 12:22:45,377 - INFO - VM ([]) created on node: (cn-jenkins-deploy-platform-ansible-os-5315-1), Zone: (nova:cn-jenkins-deploy-platform-ansible-os-5315-1)
2026-02-12 12:22:45,377 - INFO - Waiting for VM ctest-vn1-vm1-93501283 to be up..
2026-02-12 12:22:45,424 - DEBUG - VM is still in BUILD state, Expected: ACTIVE
2026-02-12 12:22:50,529 - DEBUG - VM is in ACTIVE state now
2026-02-12 12:22:50,529 - INFO - VM name : ctest-vn1-vm1-93501283
2026-02-12 12:22:50,632 - DEBUG - VM ctest-vn1-vm1-93501283 ID is 9c42cca1-dcdd-4b0c-a848-45bda087817f
2026-02-12 12:22:50,661 - DEBUG - VM ctest-vn1-vm1-93501283 launched on Node cn-jenkins-deploy-platform-ansible-os-5315-1
2026-02-12 12:22:50,768 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine/9c42cca1-dcdd-4b0c-a848-45bda087817f
2026-02-12 12:22:50,779 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine-interface/9e3dd6bf-e61a-4228-94ac-afd4b92b69ab
2026-02-12 12:22:54,068 - 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 1030ms')
2026-02-12 12:22:54,068 - DEBUG - Ping to Metadata IP 169.254.0.3 of VM ctest-vn1-vm1-93501283 failed!
2026-02-12 12:22:54,125 - DEBUG - Gateway for vn default-domain:ctest-TestPorts-98913602:ctest-vn1-46154740 is 163.81.73.65 and allocation pool is NOT set
2026-02-12 12:22:54,125 - DEBUG - Gateway for vn default-domain:ctest-TestPorts-98913602:ctest-vn1-46154740 is 60.108.128.1 and allocation pool is NOT set
2026-02-12 12:22:58,191 - 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=9.06 ms\r\n\r\n--- 169.254.0.3 ping statistics ---\r\n2 packets transmitted, 1 received, 50% packet loss, time 1006ms\r\nrtt min/avg/max/mdev = 9.061/9.061/9.061/0.000 ms')
2026-02-12 12:22:58,191 - INFO - Ping to Metadata IP 169.254.0.3 of VM ctest-vn1-vm1-93501283 passed
2026-02-12 12:22:58,349 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2026-02-12 12:22:58,349 - DEBUG - Waiting to SSH to VM ctest-vn1-vm1-93501283, IP 163.81.73.69, Port 22
2026-02-12 12:22:58,520 - DEBUG - VM ctest-vn1-vm1-93501283 is ready for SSH connections
2026-02-12 12:22:58,520 - INFO - Waiting for VM ctest-vn1-vm2-57752231 to be up..
2026-02-12 12:22:58,628 - DEBUG - VM is in ACTIVE state now
2026-02-12 12:22:58,628 - INFO - VM name : ctest-vn1-vm2-57752231
2026-02-12 12:22:58,741 - DEBUG - VM ctest-vn1-vm2-57752231 ID is c7c759e9-1c7d-4429-8450-b511393499da
2026-02-12 12:22:58,741 - DEBUG - VM ctest-vn1-vm2-57752231 launched on Node cn-jenkins-deploy-platform-ansible-os-5315-1
2026-02-12 12:22:58,850 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine/c7c759e9-1c7d-4429-8450-b511393499da
2026-02-12 12:22:58,862 - DEBUG - Requesting: http://10.0.0.73:8082/virtual-machine-interface/c8f97af8-1392-4c9d-be70-48d575fbb615
2026-02-12 12:23:00,117 - 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=3.88 ms\r\n64 bytes from 169.254.0.4: icmp_seq=2 ttl=63 time=0.531 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.531/2.207/3.884/1.676 ms')
2026-02-12 12:23:00,117 - INFO - Ping to Metadata IP 169.254.0.4 of VM ctest-vn1-vm2-57752231 passed
2026-02-12 12:23:00,277 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2026-02-12 12:23:00,277 - DEBUG - Waiting to SSH to VM ctest-vn1-vm2-57752231, IP 60.108.128.5, Port 22
2026-02-12 12:23:00,448 - DEBUG - VM ctest-vn1-vm2-57752231 is ready for SSH connections
2026-02-12 12:23:00,448 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2026-02-12 12:23:00,448 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2026-02-12 12:23:00,448 - DEBUG - verify_vm_launched is skipped since self.vm_launch_flag is set
2026-02-12 12:23:00,448 - DEBUG - Running remote_cmd, Cmd : ping -s 56 -c 3 -W 1 163.81.73.69, host_string: cirros@169.254.0.4, password: cubswin:)gateway: ubuntu@10.0.0.73, gateway password: c0ntrail123
2026-02-12 12:23:00,448 - DEBUG - ping -s 56 -c 3 -W 1 163.81.73.69
2026-02-12 12:23:03,203 - DEBUG - PING 163.81.73.69 (163.81.73.69): 56 data bytes
64 bytes from 163.81.73.69: seq=0 ttl=63 time=5.017 ms
64 bytes from 163.81.73.69: seq=1 ttl=63 time=1.185 ms
64 bytes from 163.81.73.69: seq=2 ttl=63 time=1.330 ms
--- 163.81.73.69 ping statistics ---
3 packets transmitted, 3 packets received, 0% packet loss
round-trip min/avg/max = 1.185/2.510/5.017 ms
2026-02-12 12:23:03,204 - INFO - Ping to IP 163.81.73.69 from VM ctest-vn1-vm2-57752231 passed
2026-02-12 12:23:03,204 - INFO - Detaching port c8f97af8-1392-4c9d-be70-48d575fbb615 from VM ctest-vn1-vm2-57752231
2026-02-12 12:23:03,272 - INFO - Deleting VM ctest-vn1-vm2-57752231
2026-02-12 12:23:03,392 - INFO - Detaching port 9e3dd6bf-e61a-4228-94ac-afd4b92b69ab from VM ctest-vn1-vm1-93501283
2026-02-12 12:23:03,435 - INFO - Deleting VM ctest-vn1-vm1-93501283
2026-02-12 12:23:03,738 - DEBUG - Response for delete_port : ()
2026-02-12 12:23:03,944 - DEBUG - Response for delete_port : ()
2026-02-12 12:23:03,944 - INFO - Deleting VN ctest-vn1-46154740
2026-02-12 12:23:04,122 - DEBUG - Response for deleting network ()
2026-02-12 12:23:04,392 - DEBUG - No XMPP flaps were noticed during the test
2026-02-12 12:23:04,392 - INFO - END TEST : test_ports_specific_subnet_ip : PASSED[0:00:22]
2026-02-12 12:23:04,392 - INFO - --------------------------------------------------------------------------------
2026-02-12 12:23:05,215 - INFO - Deleted project: ctest-TestPorts-98913602, ID : 60b72183-1ea8-406f-b9f3-b5edc8a0b92f