[61.696311] Initializing watchdogs
[61.696356]   /dev/watchdog0
[61.710120] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[61.714406] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[61.716742] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[61.719999] [001/132] (960s left) kms_rotation_crc (primary-y-tiled-reflect-x-0)
[61.846813] Starting subtest: primary-y-tiled-reflect-x-0
[61.929602] Subtest primary-y-tiled-reflect-x-0: SKIP (0.080s)
[62.029058] [002/132] (960s left) kms_cursor_crc (cursor-sliding-32x10)
[62.187365] Starting subtest: cursor-sliding-32x10
[62.232845] Subtest cursor-sliding-32x10: SKIP (0.043s)
[62.483355] [003/132] (959s left) kms_big_fb (x-tiled-16bpp-rotate-0)
[62.587646] Starting subtest: x-tiled-16bpp-rotate-0
[63.817741] Subtest x-tiled-16bpp-rotate-0: SUCCESS (1.234s)
[63.945956] [004/132] (958s left) kms_cursor_legacy (cursora-vs-flipa-atomic-transitions-varying-size)
[64.063971] Starting subtest: cursorA-vs-flipA-atomic-transitions-varying-size
[75.209357] Subtest cursorA-vs-flipA-atomic-transitions-varying-size: SUCCESS (11.161s)
[76.075197] [005/132] (946s left) gem_softpin (invalid)
[76.156237] Starting subtest: invalid
[76.161365] Subtest invalid: SUCCESS (0.007s)
[76.280083] [006/132] (946s left) gem_exec_balancer (parallel-bb-first)
[76.540268] Starting subtest: parallel-bb-first
[77.461762] Subtest parallel-bb-first: SUCCESS (0.922s)
[77.897603] [007/132] (944s left) dumb_buffer (map-valid)
[77.959344] Starting subtest: map-valid
[77.961702] Subtest map-valid: SUCCESS (0.000s)
[78.066242] [008/132] (944s left) perf_pmu (most-busy-idle-check-all)
[78.102354] Starting subtest: most-busy-idle-check-all
[78.104681] Starting dynamic subtest: rcs0
[79.893634] Dynamic subtest rcs0: SUCCESS (1.790s)
[79.904667] Starting dynamic subtest: bcs0
[81.878746] Dynamic subtest bcs0: SUCCESS (1.982s)
[81.889867] Starting dynamic subtest: vcs0
[83.862892] Dynamic subtest vcs0: SUCCESS (1.982s)
[83.873948] Starting dynamic subtest: vcs1
[85.909583] Dynamic subtest vcs1: SUCCESS (2.044s)
[85.920132] Starting dynamic subtest: vecs0
[87.894565] Dynamic subtest vecs0: SUCCESS (1.983s)
[87.905352] Starting dynamic subtest: ccs0
[89.878993] Dynamic subtest ccs0: SUCCESS (1.982s)
[89.881741] Subtest most-busy-idle-check-all: SUCCESS (11.778s)
[89.978957] [009/132] (932s left) kms_psr (fbc-pr-sprite-plane-onoff)
[90.082124] Starting subtest: fbc-pr-sprite-plane-onoff
[90.086687] Subtest fbc-pr-sprite-plane-onoff: SKIP (0.000s)
[90.154220] [010/132] (932s left) gem_render_copy (y-tiled-mc-ccs-to-y-tiled-ccs)
[90.208597] Starting subtest: y-tiled-mc-ccs-to-y-tiled-ccs
[90.213248] Subtest y-tiled-mc-ccs-to-y-tiled-ccs: SKIP (0.000s)
[90.392794] [011/132] (932s left) kms_psr (psr2-cursor-plane-move)
[90.488301] Starting subtest: psr2-cursor-plane-move
[90.490670] Starting dynamic subtest: eDP-1
[92.156262] Dynamic subtest eDP-1: SUCCESS (1.668s)
[92.158464] Subtest psr2-cursor-plane-move: SUCCESS (1.669s)
[92.948189] [012/132] (929s left) gem_exec_reloc (basic-write-gtt-active)
[92.997982] Subtest basic-write-gtt-active: SKIP (0.000s)
[93.075938] [013/132] (929s left) gem_exec_schedule (preemptive-hang)
[93.255031] Starting subtest: preemptive-hang
[93.257866] Starting dynamic subtest: rcs0
[102.023869] Dynamic subtest rcs0: SUCCESS (8.767s)
[102.034475] Starting dynamic subtest: bcs0
[111.039413] Dynamic subtest bcs0: SUCCESS (9.014s)
[111.051726] Starting dynamic subtest: vcs0
[119.995729] Dynamic subtest vcs0: SUCCESS (8.958s)
[120.004873] Starting dynamic subtest: vcs1
[129.025861] Dynamic subtest vcs1: SUCCESS (9.027s)
[129.035821] Starting dynamic subtest: vecs0
[138.039461] Dynamic subtest vecs0: SUCCESS (9.012s)
[138.049961] Starting dynamic subtest: ccs0
[147.008828] Dynamic subtest ccs0: SUCCESS (8.966s)
[147.011517] Subtest preemptive-hang: SUCCESS (53.752s)
[147.253158] [014/132] (875s left) kms_ccs (bad-rotation-90-4-tiled-dg2-rc-ccs)
[147.364934] Starting subtest: bad-rotation-90-4-tiled-dg2-rc-ccs
[147.367540] Starting dynamic subtest: pipe-A-eDP-1
[147.391900] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[147.402483] Starting dynamic subtest: pipe-B-eDP-1
[147.423739] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[147.431585] Starting dynamic subtest: pipe-C-eDP-1
[147.453209] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[147.460673] Starting dynamic subtest: pipe-D-eDP-1
[147.482737] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[147.487188] Subtest bad-rotation-90-4-tiled-dg2-rc-ccs: SKIP (0.003s)
[149.615578] [015/132] (873s left) kms_chamelium_hpd (vga-hpd)
[150.003342] Subtest vga-hpd: SKIP (0.000s)
[150.839816] [016/132] (871s left) gem_mmap_gtt (basic-small-copy-odd)
[150.893029] Subtest basic-small-copy-odd: SKIP (0.000s)
[150.987955] [017/132] (871s left) kms_psr2_sf (fbc-psr2-plane-move-sf-dmg-area)
[151.086822] Starting subtest: fbc-psr2-plane-move-sf-dmg-area
[151.089153] Starting dynamic subtest: pipe-A-eDP-1
[151.170542] Dynamic subtest pipe-A-eDP-1: SKIP (0.088s)
[151.180141] Starting dynamic subtest: pipe-B-eDP-1
[152.330310] Dynamic subtest pipe-B-eDP-1: SKIP (1.156s)
[152.334657] Subtest fbc-psr2-plane-move-sf-dmg-area: SKIP (1.247s)
[153.511977] [018/132] (869s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-modifier)
[153.598287] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-modifier
[153.623692] Starting dynamic subtest: pipe-A-plane-0
[153.934851] Dynamic subtest pipe-A-plane-0: SUCCESS (0.311s)
[153.943689] Starting dynamic subtest: pipe-A-plane-3
[154.168674] Dynamic subtest pipe-A-plane-3: SUCCESS (0.233s)
[154.177730] Starting dynamic subtest: pipe-A-plane-5
[154.182302] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[155.301127] Starting dynamic subtest: pipe-B-plane-0
[155.561712] Dynamic subtest pipe-B-plane-0: SUCCESS (0.267s)
[155.574052] Starting dynamic subtest: pipe-B-plane-3
[155.795520] Dynamic subtest pipe-B-plane-3: SUCCESS (0.233s)
[155.803276] Starting dynamic subtest: pipe-B-plane-5
[155.807482] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[156.100292] Subtest pixel-format-4-tiled-mtl-rc-ccs-modifier: SUCCESS (2.504s)
[156.977337] [019/132] (865s left) i915_drm_fdinfo (virtual-busy)
[157.019130] Starting subtest: virtual-busy
[157.023141] Subtest virtual-busy: SKIP (0.000s)
[157.078506] [020/132] (865s left) gem_mmap_wc (write)
[157.139372] Subtest write: SKIP (0.000s)
[157.191143] [021/132] (865s left) gem_ctx_shared (detached-shared-gtt)
[157.247308] Starting subtest: detached-shared-gtt
[159.400196] Subtest detached-shared-gtt: SUCCESS (2.151s)
[159.791694] [022/132] (863s left) kms_flip (2x-flip-vs-modeset-vs-hang)
[159.883840] Starting subtest: 2x-flip-vs-modeset-vs-hang
[159.894842] Subtest 2x-flip-vs-modeset-vs-hang: SKIP (0.010s)
[159.970957] [023/132] (863s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-mc-ccs)
[160.060207] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-mc-ccs
[160.062080] Starting dynamic subtest: pipe-A-eDP-1
[162.104192] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.045s)
[162.111919] Starting dynamic subtest: pipe-B-eDP-1
[164.231875] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.126s)
[164.239687] Starting dynamic subtest: pipe-C-eDP-1
[166.405977] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.173s)
[166.414163] Starting dynamic subtest: pipe-D-eDP-1
[168.452301] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.045s)
[168.454479] Subtest crc-primary-rotation-180-4-tiled-mtl-mc-ccs: SUCCESS (8.394s)
[169.684117] [024/132] (853s left) gem_exec_schedule (u-lateslice)
[169.764184] Starting subtest: u-lateslice
[169.766543] Starting dynamic subtest: rcs0
[169.773829] Dynamic subtest rcs0: SUCCESS (0.021s)
[169.783277] Starting dynamic subtest: bcs0
[169.791161] Dynamic subtest bcs0: SUCCESS (0.017s)
[169.798812] Starting dynamic subtest: vcs0
[169.811577] Dynamic subtest vcs0: SUCCESS (0.019s)
[169.819400] Starting dynamic subtest: vcs1
[169.829051] Dynamic subtest vcs1: SUCCESS (0.017s)
[169.842659] Starting dynamic subtest: vecs0
[169.847608] Dynamic subtest vecs0: SUCCESS (0.016s)
[169.854967] Starting dynamic subtest: ccs0
[169.862670] Dynamic subtest ccs0: SUCCESS (0.016s)
[169.865101] Subtest u-lateslice: SUCCESS (0.111s)
[170.975059] [025/132] (852s left) gem_tiled_fence_blits (basic)
[171.038870] Subtest basic: SKIP (0.000s)
[171.110752] [026/132] (852s left) kms_concurrent (multi-plane-atomic-lowres)
[171.206172] Starting subtest: multi-plane-atomic-lowres
[171.208369] Starting dynamic subtest: pipe-A-eDP-1
[171.715985] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.510s)
[171.724697] Starting dynamic subtest: pipe-B-eDP-1
[172.972973] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.253s)
[172.989576] Starting dynamic subtest: pipe-C-eDP-1
[174.150253] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.177s)
[174.158633] Starting dynamic subtest: pipe-D-eDP-1
[175.416601] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.266s)
[175.418948] Subtest multi-plane-atomic-lowres: SUCCESS (4.211s)
[176.236158] [027/132] (847s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc)
[176.337901] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc
[183.396375] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (7.063s)
[183.528633] [028/132] (839s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[183.627811] Starting subtest: nonblocking-crc-frame-sequence
[183.630219] Starting dynamic subtest: pipe-A-eDP-1
[184.362706] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.735s)
[184.371364] Starting dynamic subtest: pipe-B-eDP-1
[185.827861] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.463s)
[185.836870] Starting dynamic subtest: pipe-C-eDP-1
[187.190408] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.361s)
[187.198919] Starting dynamic subtest: pipe-D-eDP-1
[188.527646] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.337s)
[188.529960] Subtest nonblocking-crc-frame-sequence: SUCCESS (4.902s)
[189.325932] [029/132] (833s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-msflip-blt)
[189.428954] Starting subtest: fbcpsr-2p-primscrn-shrfb-msflip-blt
[189.433442] Subtest fbcpsr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[189.524881] [030/132] (833s left) kms_addfb_basic (invalid-set-prop)
[189.582413] Starting subtest: invalid-set-prop
[189.584575] Subtest invalid-set-prop: SUCCESS (0.000s)
[189.711040] [031/132] (833s left) kms_atomic_interruptible (legacy-dpms)
[189.804275] Starting subtest: legacy-dpms
[189.806578] Starting dynamic subtest: pipe-A-eDP-1
[197.278827] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.475s)
[197.281134] Subtest legacy-dpms: SUCCESS (7.477s)
[198.085977] [032/132] (825s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-downscaling)
[198.199067] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-downscaling
[198.203285] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-downscaling: SKIP (0.000s)
[198.268698] [033/132] (825s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[198.372982] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu
[202.352083] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (3.981s)
[203.491509] [034/132] (820s left) kms_cursor_legacy (cursora-vs-flipb-toggle)
[203.610635] Starting subtest: cursorA-vs-flipB-toggle
[203.615315] Subtest cursorA-vs-flipB-toggle: SKIP (0.001s)
[203.750369] [035/132] (819s left) gem_eio (in-flight-10ms)
[203.969642] Starting subtest: in-flight-10ms
[212.838572] Subtest in-flight-10ms: SUCCESS (8.867s)
[212.950242] [FACT gem_eio (in-flight-10ms)] new: kernel.kmod_is_loaded.vgem: true
[212.953409] [036/132] (810s left) kms_big_fb (4-tiled-8bpp-rotate-180)
[213.043159] Starting subtest: 4-tiled-8bpp-rotate-180
[214.256376] Subtest 4-tiled-8bpp-rotate-180: SUCCESS (1.215s)
[214.402485] [037/132] (809s left) api_intel_allocator (two-level-inception-interruptible)
[214.459227] Starting subtest: two-level-inception-interruptible
[219.866330] Subtest two-level-inception-interruptible: SUCCESS (5.407s)
[219.995716] [038/132] (803s left) kms_pm_dc (dc3co-vpb-simulation)
[221.110297] Starting subtest: dc3co-vpb-simulation
[229.860318] Subtest dc3co-vpb-simulation: SKIP (8.746s)
[230.016354] [039/132] (793s left) gem_fenced_exec_thrash (no-spare-fences-busy)
[230.080038] Subtest no-spare-fences-busy: SKIP (0.000s)
[230.149506] [040/132] (793s left) kms_big_fb (y-tiled-64bpp-rotate-270)
[230.247065] Starting subtest: y-tiled-64bpp-rotate-270
[230.251414] Subtest y-tiled-64bpp-rotate-270: SKIP (0.000s)
[230.356016] [041/132] (793s left) gem_exec_params (invalid-ring)
[230.407741] Starting subtest: invalid-ring
[230.410048] Subtest invalid-ring: SUCCESS (0.000s)
[230.520280] [042/132] (793s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-render)
[230.615747] Starting subtest: fbcpsr-rgb101010-draw-render
[237.337273] Subtest fbcpsr-rgb101010-draw-render: SUCCESS (6.725s)
[237.450684] [043/132] (786s left) kms_flip (2x-plain-flip-fb-recreate-interruptible)
[237.542245] Starting subtest: 2x-plain-flip-fb-recreate-interruptible
[237.553205] Subtest 2x-plain-flip-fb-recreate-interruptible: SKIP (0.010s)
[237.629570] [044/132] (786s left) syncobj_wait (single-wait-submitted)
[237.683584] Starting subtest: single-wait-submitted
[237.788662] Subtest single-wait-submitted: SUCCESS (0.102s)
[237.874114] [045/132] (786s left) dmabuf_sync_file (export-before-signal)
[237.915469] Starting subtest: export-before-signal
[237.917771] Subtest export-before-signal: SUCCESS (0.000s)
[237.972827] [046/132] (786s left) gem_exec_reloc (basic-write-cpu-noreloc)
[238.026072] Subtest basic-write-cpu-noreloc: SKIP (0.000s)
[238.087967] [047/132] (785s left) gem_exec_fence (syncobj-timeline-wait)
[238.634451] Starting subtest: syncobj-timeline-wait
[239.907295] Subtest syncobj-timeline-wait: SUCCESS (1.272s)
[242.006418] [048/132] (782s left) kms_flip (absolute-wf_vblank-interruptible)
[242.101267] Starting subtest: absolute-wf_vblank-interruptible
[242.103607] Starting dynamic subtest: A-eDP1
[250.846361] Dynamic subtest A-eDP1: SUCCESS (8.744s)
[250.857079] Starting dynamic subtest: B-eDP1
[259.572275] Dynamic subtest B-eDP1: SUCCESS (8.724s)
[259.583823] Starting dynamic subtest: C-eDP1
[268.296580] Dynamic subtest C-eDP1: SUCCESS (8.723s)
[268.305298] Starting dynamic subtest: D-eDP1
[277.030563] Dynamic subtest D-eDP1: SUCCESS (8.732s)
[277.035602] Subtest absolute-wf_vblank-interruptible: SUCCESS (34.934s)
[278.235148] [049/132] (745s left) kms_psr2_sf (psr2-overlay-plane-update-continuous-sf)
[278.339751] Starting subtest: psr2-overlay-plane-update-continuous-sf
[278.342087] Starting dynamic subtest: pipe-A-eDP-1
[279.453920] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.117s)
[279.463294] Starting dynamic subtest: pipe-B-eDP-1
[281.186530] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.731s)
[281.188579] Subtest psr2-overlay-plane-update-continuous-sf: SUCCESS (2.851s)
[282.003596] [050/132] (742s left) gem_wait (wait)
[282.061854] Starting subtest: wait
[282.064168] Starting dynamic subtest: all-engines
[283.926107] Dynamic subtest all-engines: SUCCESS (1.862s)
[283.938273] Starting dynamic subtest: rcs0
[284.972569] Dynamic subtest rcs0: SUCCESS (1.046s)
[284.984174] Starting dynamic subtest: bcs0
[286.020565] Dynamic subtest bcs0: SUCCESS (1.046s)
[286.031881] Starting dynamic subtest: vcs0
[287.067071] Dynamic subtest vcs0: SUCCESS (1.044s)
[287.078400] Starting dynamic subtest: vcs1
[288.112694] Dynamic subtest vcs1: SUCCESS (1.043s)
[288.124619] Starting dynamic subtest: vecs0
[289.158085] Dynamic subtest vecs0: SUCCESS (1.043s)
[289.169423] Starting dynamic subtest: ccs0
[290.205829] Dynamic subtest ccs0: SUCCESS (1.045s)
[290.208826] Subtest wait: SUCCESS (8.144s)
[290.405261] [051/132] (733s left) gem_ctx_engines (execute-one)
[290.474540] Starting subtest: execute-one
[294.261531] Subtest execute-one: SUCCESS (3.787s)
[294.449613] [052/132] (729s left) kms_color (degamma)
[294.542791] Starting subtest: degamma
[294.544938] Starting dynamic subtest: pipe-A-eDP-1
[295.255426] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.712s)
[295.265135] Starting dynamic subtest: pipe-B-eDP-1
[296.706630] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.450s)
[296.715713] Starting dynamic subtest: pipe-C-eDP-1
[298.078319] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.369s)
[298.088411] Starting dynamic subtest: pipe-D-eDP-1
[299.415434] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.337s)
[299.417646] Subtest degamma: SUCCESS (4.872s)
[300.226654] [053/132] (724s left) gem_exec_balancer (sequential)
[300.282278] Starting subtest: sequential
[303.345572] Subtest sequential: SUCCESS (3.066s)
[303.679189] [054/132] (720s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[303.786578] Starting subtest: addfb25-yf-tiled-legacy
[303.788592] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s)
[303.892721] [055/132] (720s left) kms_chamelium_frames (dp-crc-single)
[304.287833] Subtest dp-crc-single: SKIP (0.000s)
[305.145424] [056/132] (719s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-render)
[305.255604] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-render
[312.127252] Subtest psr-1p-offscreen-pri-shrfb-draw-render: SUCCESS (6.873s)
[312.287034] [057/132] (712s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[312.346071] Starting subtest: x-tiled-to-vebox-y-tiled
[312.350707] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s)
[312.540125] [058/132] (711s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-wc)
[312.648894] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-wc
[319.575714] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (6.930s)
[319.690032] [059/132] (704s left) kms_cursor_legacy (single-move)
[319.806525] Starting subtest: single-move
[319.808578] Starting dynamic subtest: pipe-A
[325.188816] Dynamic subtest pipe-A: SUCCESS (5.379s)
[325.200393] Starting dynamic subtest: pipe-B
[330.571033] Dynamic subtest pipe-B: SUCCESS (5.379s)
[330.582177] Starting dynamic subtest: pipe-C
[335.953124] Dynamic subtest pipe-C: SUCCESS (5.379s)
[335.964503] Starting dynamic subtest: pipe-D
[341.335596] Dynamic subtest pipe-D: SUCCESS (5.379s)
[341.346760] Starting dynamic subtest: all-pipes
[346.724073] Dynamic subtest all-pipes: SUCCESS (5.386s)
[346.726539] Subtest single-move: SUCCESS (26.916s)
[346.870655] [060/132] (677s left) i915_selftest (perf)
[348.638482] Starting subtest: perf
[348.641223] Starting dynamic subtest: engine_cs
[351.427089] Dynamic subtest engine_cs: SUCCESS (2.789s)
[351.436678] Starting dynamic subtest: request
[356.697093] Dynamic subtest request: SUCCESS (5.268s)
[356.705666] Starting dynamic subtest: migrate
[360.992549] Dynamic subtest migrate: SUCCESS (4.293s)
[361.002514] Starting dynamic subtest: region
[365.119945] Dynamic subtest region: SUCCESS (4.126s)
[365.122581] Subtest perf: SUCCESS (16.483s)
[365.149653] [FACT i915_selftest (perf)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[365.150383] [FACT i915_selftest (perf)] deleted: kernel.kmod_is_loaded.i915: true
[365.153440] [061/132] (659s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-move)
[366.696788] Starting subtest: psr-2p-primscrn-spr-indfb-move
[366.700810] Subtest psr-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[366.790172] [FACT kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-move)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[366.791357] [FACT kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-move)] new: kernel.kmod_is_loaded.i915: true
[366.794923] [062/132] (657s left) gen9_exec_parse (secure-batches)
[366.862775] Subtest secure-batches: SKIP (0.000s)
[366.927162] [063/132] (657s left) gem_exec_whisper (basic-fds)
[366.989523] Starting subtest: basic-fds
[373.086287] Subtest basic-fds: SUCCESS (6.093s)
[373.280244] [064/132] (651s left) kms_lease (lease-revoke)
[373.387025] Starting subtest: lease-revoke
[373.389319] Starting dynamic subtest: pipe-A-eDP-1
[373.421379] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.035s)
[373.431228] Starting dynamic subtest: pipe-B-eDP-1
[373.447627] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.026s)
[373.456322] Starting dynamic subtest: pipe-C-eDP-1
[373.479113] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.027s)
[373.487521] Starting dynamic subtest: pipe-D-eDP-1
[373.503035] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.025s)
[373.505431] Subtest lease-revoke: SUCCESS (0.119s)
[373.640583] [065/132] (651s left) gem_ctx_persistence (legacy-engines-queued)
[373.699576] Starting subtest: legacy-engines-queued
[373.701838] Starting dynamic subtest: render
[373.765396] Dynamic subtest render: SUCCESS (0.066s)
[373.778314] Starting dynamic subtest: bsd1
[374.902838] Dynamic subtest bsd1: SUCCESS (1.133s)
[374.914818] Starting dynamic subtest: bsd2
[376.884359] Dynamic subtest bsd2: SUCCESS (1.977s)
[376.895599] Starting dynamic subtest: blt
[376.940198] Dynamic subtest blt: SUCCESS (0.053s)
[376.951140] Starting dynamic subtest: vebox
[378.868335] Dynamic subtest vebox: SUCCESS (1.925s)
[378.871524] Subtest legacy-engines-queued: SUCCESS (5.169s)
[378.960060] [066/132] (645s left) kms_psr (psr-dpms)
[379.073855] Starting subtest: psr-dpms
[379.076058] Starting dynamic subtest: eDP-1
[382.063802] Dynamic subtest eDP-1: SUCCESS (2.989s)
[382.065932] Subtest psr-dpms: SUCCESS (2.990s)
[382.932454] [067/132] (641s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-plflip-blt)
[383.044749] Starting subtest: psr-1p-primscrn-indfb-plflip-blt
[390.569932] Subtest psr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.527s)
[390.691851] [068/132] (634s left) i915_module_load (resize-bar)
[390.738625] Starting subtest: resize-bar
[390.745148] Subtest resize-bar: SKIP (0.006s)
[390.792889] [069/132] (634s left) kms_feature_discovery (dp-mst)
[390.888063] Starting subtest: dp-mst
[390.892379] Subtest dp-mst: SKIP (0.000s)
[390.960989] [070/132] (634s left) syncobj_timeline (device-signal-unordered)
[391.011651] Starting subtest: device-signal-unordered
[391.013654] Subtest device-signal-unordered: SUCCESS (0.001s)
[391.129523] [071/132] (633s left) syncobj_timeline (etime-single-wait-for-submit-unsubmitted)
[391.173174] Starting subtest: etime-single-wait-for-submit-unsubmitted
[391.281658] Subtest etime-single-wait-for-submit-unsubmitted: SUCCESS (0.107s)
[391.372312] [072/132] (633s left) vgem_basic (busy-fence)
[391.410594] Starting subtest: busy-fence
[391.412641] Subtest busy-fence: SUCCESS (0.000s)
[391.469517] [073/132] (633s left) syncobj_basic (bad-handle-to-fd)
[391.529435] Starting subtest: bad-handle-to-fd
[391.531416] Subtest bad-handle-to-fd: SUCCESS (0.000s)
[391.618935] [074/132] (633s left) gem_mmap_wc (invalid-flags)
[391.678626] Subtest invalid-flags: SKIP (0.000s)
[391.734389] [075/132] (633s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-cpu)
[391.819421] Starting subtest: psr-rgb101010-draw-mmap-cpu
[398.894229] Subtest psr-rgb101010-draw-mmap-cpu: SUCCESS (7.077s)
[399.019825] [076/132] (626s left) kms_plane_scaling (plane-downscale-factor-0-75-with-modifiers)
[399.126113] Starting subtest: plane-downscale-factor-0-75-with-modifiers
[399.128436] Starting dynamic subtest: pipe-A
[399.499395] Dynamic subtest pipe-A: SUCCESS (0.375s)
[399.508929] Starting dynamic subtest: pipe-B
[400.901278] Dynamic subtest pipe-B: SUCCESS (1.401s)
[400.909856] Starting dynamic subtest: pipe-C
[402.358233] Dynamic subtest pipe-C: SUCCESS (1.455s)
[402.367617] Starting dynamic subtest: pipe-D
[403.822081] Dynamic subtest pipe-D: SUCCESS (1.463s)
[403.824295] Subtest plane-downscale-factor-0-75-with-modifiers: SUCCESS (4.699s)
[405.059957] [077/132] (620s left) gem_mmap_offset (bad-extensions)
[405.119680] Starting subtest: bad-extensions
[405.122153] Subtest bad-extensions: SUCCESS (0.000s)
[405.251139] [078/132] (620s left) kms_big_fb (linear-64bpp-rotate-90)
[405.362187] Starting subtest: linear-64bpp-rotate-90
[405.380783] Subtest linear-64bpp-rotate-90: SKIP (0.019s)
[405.484814] [079/132] (619s left) kms_big_fb (yf-tiled-64bpp-rotate-90)
[405.587362] Starting subtest: yf-tiled-64bpp-rotate-90
[405.591412] Subtest yf-tiled-64bpp-rotate-90: SKIP (0.000s)
[405.676490] [080/132] (619s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-pwrite)
[405.784606] Starting subtest: psr-2p-primscrn-pri-indfb-draw-pwrite
[405.788706] Subtest psr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[405.888438] [081/132] (619s left) kms_chamelium_color (ctm-0-50)
[405.990492] Subtest ctm-0-50: SKIP (0.000s)
[406.035365] [082/132] (619s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-exceed-sf)
[406.125805] Starting subtest: fbc-pr-overlay-plane-move-continuous-exceed-sf
[406.129480] Subtest fbc-pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[406.194507] [083/132] (619s left) i915_pm_rpm (gem-mmap-type)
[408.037416] Starting subtest: gem-mmap-type
[408.040408] Starting dynamic subtest: wb-smem0
[411.301532] Dynamic subtest wb-smem0: SUCCESS (3.261s)
[411.315543] Starting dynamic subtest: wc-smem0
[414.489719] Dynamic subtest wc-smem0: SUCCESS (3.189s)
[414.498555] Starting dynamic subtest: uc-smem0
[417.619792] Dynamic subtest uc-smem0: SUCCESS (3.129s)
[417.622122] Subtest gem-mmap-type: SUCCESS (9.582s)
[417.712511] [084/132] (607s left) gem_lmem_swapping (parallel-random-verify)
[417.761066] Subtest parallel-random-verify: SKIP (0.000s)
[417.810615] [085/132] (607s left) syncobj_wait (wait-all-complex)
[417.867524] Starting subtest: wait-all-complex
[418.081053] Subtest wait-all-complex: SUCCESS (0.213s)
[418.158851] [086/132] (607s left) gem_mmap_wc (copy)
[418.218745] Subtest copy: SKIP (0.000s)
[418.284210] [087/132] (607s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-wc)
[418.393775] Starting subtest: fbc-rgb101010-draw-mmap-wc
[422.970516] Subtest fbc-rgb101010-draw-mmap-wc: SUCCESS (4.578s)
[424.081885] [088/132] (601s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite)
[424.181911] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite
[424.186135] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[424.277359] [089/132] (601s left) syncobj_timeline (invalid-query-illegal-handle)
[424.326874] Starting subtest: invalid-query-illegal-handle
[424.329092] Subtest invalid-query-illegal-handle: SUCCESS (0.000s)
[424.434893] [090/132] (601s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-pwrite)
[424.527498] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-pwrite
[428.860609] Subtest fbc-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (4.336s)
[430.115530] [091/132] (595s left) kms_psr (fbc-psr-primary-mmap-cpu)
[430.216206] Starting subtest: fbc-psr-primary-mmap-cpu
[430.218460] Starting dynamic subtest: eDP-1
[430.222865] Dynamic subtest eDP-1: SKIP (0.000s)
[430.227250] Subtest fbc-psr-primary-mmap-cpu: SKIP (0.001s)
[430.289640] [092/132] (595s left) kms_vrr (max-min)
[430.384266] Starting subtest: max-min
[430.390853] Subtest max-min: SKIP (0.000s)
[430.458845] [093/132] (595s left) api_intel_bb (simple-bb-ctx)
[430.511733] Starting subtest: simple-bb-ctx
[430.519354] Subtest simple-bb-ctx: SUCCESS (0.008s)
[430.644395] [094/132] (595s left) gem_exec_fence (parallel)
[430.822263] Starting subtest: parallel
[430.824655] Starting dynamic subtest: rcs0
[432.974398] Dynamic subtest rcs0: SUCCESS (2.155s)
[432.983665] Starting dynamic subtest: bcs0
[435.124072] Dynamic subtest bcs0: SUCCESS (2.149s)
[435.134483] Starting dynamic subtest: vcs0
[437.280970] Dynamic subtest vcs0: SUCCESS (2.155s)
[437.293155] Starting dynamic subtest: vcs1
[439.436046] Dynamic subtest vcs1: SUCCESS (2.154s)
[439.448862] Starting dynamic subtest: vecs0
[441.593583] Dynamic subtest vecs0: SUCCESS (2.156s)
[441.604284] Starting dynamic subtest: ccs0
[443.747797] Dynamic subtest ccs0: SUCCESS (2.153s)
[443.749792] Subtest parallel: SUCCESS (12.929s)
[445.977463] [095/132] (580s left) kms_psr (pr-primary-blt)
[446.075154] Starting subtest: pr-primary-blt
[446.079488] Subtest pr-primary-blt: SKIP (0.000s)
[446.163581] [096/132] (579s left) kms_cursor_crc (cursor-onscreen-256x85)
[446.414292] Starting subtest: cursor-onscreen-256x85
[446.470297] Subtest cursor-onscreen-256x85: SKIP (0.050s)
[446.643271] [097/132] (579s left) gem_userptr_blits (map-fixed-invalidate)
[446.712700] Starting subtest: map-fixed-invalidate
[446.716804] Subtest map-fixed-invalidate: SKIP (0.000s)
[446.832333] [098/132] (579s left) gem_mmap_wc (write-prefaulted)
[446.886674] Subtest write-prefaulted: SKIP (0.000s)
[446.942286] [099/132] (579s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping)
[447.041616] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping
[447.045153] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping: SKIP (0.000s)
[447.119955] [100/132] (579s left) kms_pm_rpm (pm-caching)
[449.055468] Starting subtest: pm-caching
[449.059946] Subtest pm-caching: SKIP (0.000s)
[449.442506] [101/132] (576s left) kms_universal_plane (universal-plane-functional)
[449.532951] Starting subtest: universal-plane-functional
[449.534830] Starting dynamic subtest: pipe-A-eDP-1
[453.480056] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.947s)
[453.489584] Starting dynamic subtest: pipe-B-eDP-1
[457.996978] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.516s)
[458.007171] Starting dynamic subtest: pipe-C-eDP-1
[462.233915] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.233s)
[462.243218] Starting dynamic subtest: pipe-D-eDP-1
[466.512443] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.277s)
[466.514395] Subtest universal-plane-functional: SUCCESS (16.978s)
[467.314570] [102/132] (559s left) sw_sync (sync_busy)
[467.359832] Starting subtest: sync_busy
[467.362191] Subtest sync_busy: SUCCESS (0.002s)
[467.414924] [103/132] (558s left) gem_fence_thrash (bo-write-verify-x)
[467.455639] Starting subtest: bo-write-verify-x
[467.475707] Subtest bo-write-verify-x: SKIP (0.015s)
[467.545135] [104/132] (558s left) gem_exec_whisper (basic-queues-all)
[467.603841] Starting subtest: basic-queues-all
[478.838572] Subtest basic-queues-all: SUCCESS (11.230s)
[479.020842] [105/132] (547s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[479.127941] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu
[485.697395] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (6.573s)
[485.821693] [106/132] (540s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-render)
[485.926735] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-render
[492.852548] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-render: SUCCESS (6.928s)
[493.021316] [107/132] (533s left) gem_ctx_param (vm)
[493.091742] Starting subtest: vm
[493.135897] Subtest vm: SUCCESS (0.048s)
[493.278152] [108/132] (533s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[493.373407] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[493.986640] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.614s)
[494.135280] [109/132] (532s left) syncobj_timeline (wait-any-complex)
[494.182608] Starting subtest: wait-any-complex
[494.245122] Subtest wait-any-complex: SUCCESS (0.063s)
[494.321924] [110/132] (532s left) kms_cursor_crc (cursor-rapid-movement-128x128)
[494.523795] Starting subtest: cursor-rapid-movement-128x128
[494.528477] Starting dynamic subtest: pipe-A-eDP-1
[495.119469] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.591s)
[495.147021] Starting dynamic subtest: pipe-D-eDP-1
[496.352247] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.210s)
[496.354211] Subtest cursor-rapid-movement-128x128: SUCCESS (1.828s)
[497.222891] [111/132] (529s left) gem_softpin (allocator-nopin-reserve)
[497.272853] Starting subtest: allocator-nopin-reserve
[497.354346] Subtest allocator-nopin-reserve: SUCCESS (0.082s)
[497.486819] [112/132] (529s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-downscaling)
[497.579313] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-downscaling
[497.583479] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-downscaling: SKIP (0.000s)
[497.653278] [113/132] (529s left) syncobj_timeline (multi-wait-all-for-submit-signaled)
[497.719389] Starting subtest: multi-wait-all-for-submit-signaled
[497.722051] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.001s)
[497.833851] [114/132] (529s left) kms_invalid_mode (overflow-vrefresh)
[497.938983] Starting subtest: overflow-vrefresh
[497.941220] Starting dynamic subtest: pipe-A-eDP-1
[498.224766] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s)
[498.234045] Starting dynamic subtest: pipe-B-eDP-1
[498.236311] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[498.244134] Starting dynamic subtest: pipe-C-eDP-1
[498.246279] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[498.254222] Starting dynamic subtest: pipe-D-eDP-1
[498.256361] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[498.258556] Subtest overflow-vrefresh: SUCCESS (0.289s)
[499.044445] [115/132] (527s left) kms_plane_scaling (planes-upscale-20x20-downscale-factor-0-75)
[499.136129] Starting subtest: planes-upscale-20x20-downscale-factor-0-75
[499.138346] Starting dynamic subtest: pipe-A
[499.156124] Dynamic subtest pipe-A: SKIP (0.017s)
[499.165703] Starting dynamic subtest: pipe-B
[499.187937] Dynamic subtest pipe-B: SKIP (0.031s)
[499.196176] Starting dynamic subtest: pipe-C
[499.218391] Dynamic subtest pipe-C: SKIP (0.030s)
[499.226500] Starting dynamic subtest: pipe-D
[499.248466] Dynamic subtest pipe-D: SKIP (0.030s)
[499.251962] Subtest planes-upscale-20x20-downscale-factor-0-75: SKIP (0.110s)
[499.349618] [116/132] (527s left) gem_exec_params (no-blt)
[499.413674] Starting subtest: no-blt
[499.418414] Subtest no-blt: SUCCESS (0.002s)
[499.563310] [117/132] (527s left) gem_madvise (dontneed-after-mmap)
[499.607716] Starting subtest: dontneed-after-mmap
[499.621275] Subtest dontneed-after-mmap: SUCCESS (0.017s)
[499.735615] [118/132] (527s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt)
[499.826230] Starting subtest: fbc-rgb565-draw-mmap-gtt
[499.830421] Subtest fbc-rgb565-draw-mmap-gtt: SKIP (0.000s)
[499.924350] [119/132] (527s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions)
[500.037141] Starting subtest: cursorA-vs-flipB-atomic-transitions
[500.040807] Subtest cursorA-vs-flipB-atomic-transitions: SKIP (0.001s)
[500.183919] [120/132] (526s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[500.281967] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[500.285541] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[500.377248] [121/132] (526s left) kms_ccs (crc-primary-basic-4-tiled-mtl-mc-ccs)
[500.456361] Starting subtest: crc-primary-basic-4-tiled-mtl-mc-ccs
[500.458111] Starting dynamic subtest: pipe-A-eDP-1
[502.571606] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.116s)
[502.580533] Starting dynamic subtest: pipe-B-eDP-1
[504.781549] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.208s)
[504.797162] Starting dynamic subtest: pipe-C-eDP-1
[506.795348] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.011s)
[506.804395] Starting dynamic subtest: pipe-D-eDP-1
[508.866194] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.070s)
[508.868536] Subtest crc-primary-basic-4-tiled-mtl-mc-ccs: SUCCESS (8.411s)
[510.083457] [122/132] (517s left) sriov_basic (enable-vfs-bind-unbind-each-numvfs-all)
[510.142900] Starting subtest: enable-vfs-bind-unbind-each-numvfs-all
[510.213735] Subtest enable-vfs-bind-unbind-each-numvfs-all: FAIL (0.014s)
[510.251458] [123/132] (516s left) kms_flip (2x-busy-flip)
[510.343193] Starting subtest: 2x-busy-flip
[510.351590] Subtest 2x-busy-flip: SKIP (0.010s)
[510.429715] [124/132] (516s left) gem_exec_flush (basic-batch-kernel-default-uc)
[510.494586] Starting subtest: basic-batch-kernel-default-uc
[517.788590] Subtest basic-batch-kernel-default-uc: SUCCESS (7.294s)
[517.979141] [125/132] (509s left) kms_addfb_basic (invalid-get-prop)
[518.038643] Starting subtest: invalid-get-prop
[518.041068] Subtest invalid-get-prop: SUCCESS (0.000s)
[518.175496] [126/132] (509s left) kms_flip (modeset-vs-vblank-race)
[518.261364] Starting subtest: modeset-vs-vblank-race
[518.263569] Starting dynamic subtest: A-eDP1
[523.015136] Dynamic subtest A-eDP1: SUCCESS (4.752s)
[523.027635] Starting dynamic subtest: B-eDP1
[527.744905] Dynamic subtest B-eDP1: SUCCESS (4.728s)
[527.757741] Starting dynamic subtest: C-eDP1
[532.358754] Dynamic subtest C-eDP1: SUCCESS (4.609s)
[532.369585] Starting dynamic subtest: D-eDP1
[536.895019] Dynamic subtest D-eDP1: SUCCESS (4.535s)
[536.899668] Subtest modeset-vs-vblank-race: SUCCESS (18.637s)
[538.050250] [127/132] (489s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-rc-ccs)
[538.150922] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-rc-ccs
[538.153393] Starting dynamic subtest: pipe-A-eDP-1
[538.212215] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[538.220690] Starting dynamic subtest: pipe-B-eDP-1
[538.277526] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[538.288463] Starting dynamic subtest: pipe-C-eDP-1
[538.344616] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[538.353284] Starting dynamic subtest: pipe-D-eDP-1
[538.410651] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[538.415072] Subtest crc-sprite-planes-basic-4-tiled-dg2-rc-ccs: SKIP (0.009s)
[540.324243] [128/132] (487s left) kms_atomic (plane-invalid-params-fence)
[540.433217] Starting subtest: plane-invalid-params-fence
[540.435575] Starting dynamic subtest: pipe-A-eDP-1
[540.789788] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.354s)
[540.791650] Subtest plane-invalid-params-fence: SUCCESS (0.356s)
[541.651219] [129/132] (485s left) gem_exec_flush (basic-wb-rw-default)
[541.722268] Starting subtest: basic-wb-rw-default
[547.178690] Subtest basic-wb-rw-default: SUCCESS (5.459s)
[547.367239] [130/132] (480s left) syncobj_wait (multi-wait-submitted-signaled)
[547.424563] Starting subtest: multi-wait-submitted-signaled
[547.426837] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[547.533903] [131/132] (480s left) kms_vblank (ts-continuation-idle-hang)
[547.626062] Starting subtest: ts-continuation-idle-hang
[547.627944] Starting dynamic subtest: pipe-A-eDP-1
[574.679030] Dynamic subtest pipe-A-eDP-1: SUCCESS (27.049s)
[574.694115] Starting dynamic subtest: pipe-D-eDP-1
[589.662296] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.981s)
[589.664580] Subtest ts-continuation-idle-hang: SUCCESS (42.034s)
[590.504940] [132/132] (437s left) kms_properties (get_properties-sanity-non-atomic)
[590.591986] Starting subtest: get_properties-sanity-non-atomic
[590.594304] Subtest get_properties-sanity-non-atomic: SUCCESS (0.001s)
[590.674490] Closing watchdogs
results: parsing output: 0/ for test: kms_rotation_crc
results: parsing output: 1/ for test: kms_cursor_crc
results: parsing output: 2/ for test: kms_big_fb
results: parsing output: 3/ for test: kms_cursor_legacy
results: parsing output: 4/ for test: gem_softpin
results: parsing output: 5/ for test: gem_exec_balancer
results: parsing output: 6/ for test: dumb_buffer
results: parsing output: 7/ for test: perf_pmu
results: parsing output: 8/ for test: kms_psr
results: parsing output: 9/ for test: gem_render_copy
results: parsing output: 10/ for test: kms_psr
results: parsing output: 11/ for test: gem_exec_reloc
results: parsing output: 12/ for test: gem_exec_schedule
results: parsing output: 13/ for test: kms_ccs
results: parsing output: 14/ for test: kms_chamelium_hpd
results: parsing output: 15/ for test: gem_mmap_gtt
results: parsing output: 16/ for test: kms_psr2_sf
results: parsing output: 17/ for test: kms_plane
results: parsing output: 18/ for test: i915_drm_fdinfo
results: parsing output: 19/ for test: gem_mmap_wc
results: parsing output: 20/ for test: gem_ctx_shared
results: parsing output: 21/ for test: kms_flip
results: parsing output: 22/ for test: kms_ccs
results: parsing output: 23/ for test: gem_exec_schedule
results: parsing output: 24/ for test: gem_tiled_fence_blits
results: parsing output: 25/ for test: kms_concurrent
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: kms_pipe_crc_basic
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: kms_addfb_basic
results: parsing output: 30/ for test: kms_atomic_interruptible
results: parsing output: 31/ for test: kms_flip_scaled_crc
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: kms_cursor_legacy
results: parsing output: 34/ for test: gem_eio
results: parsing output: 35/ for test: kms_big_fb
results: parsing output: 36/ for test: api_intel_allocator
results: parsing output: 37/ for test: kms_pm_dc
results: parsing output: 38/ for test: gem_fenced_exec_thrash
results: parsing output: 39/ for test: kms_big_fb
results: parsing output: 40/ for test: gem_exec_params
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_flip
results: parsing output: 43/ for test: syncobj_wait
results: parsing output: 44/ for test: dmabuf_sync_file
results: parsing output: 45/ for test: gem_exec_reloc
results: parsing output: 46/ for test: gem_exec_fence
results: parsing output: 47/ for test: kms_flip
results: parsing output: 48/ for test: kms_psr2_sf
results: parsing output: 49/ for test: gem_wait
results: parsing output: 50/ for test: gem_ctx_engines
results: parsing output: 51/ for test: kms_color
results: parsing output: 52/ for test: gem_exec_balancer
results: parsing output: 53/ for test: kms_addfb_basic
results: parsing output: 54/ for test: kms_chamelium_frames
results: parsing output: 55/ for test: kms_frontbuffer_tracking
results: parsing output: 56/ for test: gem_render_copy
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: kms_cursor_legacy
results: parsing output: 59/ for test: i915_selftest
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: gen9_exec_parse
results: parsing output: 62/ for test: gem_exec_whisper
results: parsing output: 63/ for test: kms_lease
results: parsing output: 64/ for test: gem_ctx_persistence
results: parsing output: 65/ for test: kms_psr
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: i915_module_load
results: parsing output: 68/ for test: kms_feature_discovery
results: parsing output: 69/ for test: syncobj_timeline
results: parsing output: 70/ for test: syncobj_timeline
results: parsing output: 71/ for test: vgem_basic
results: parsing output: 72/ for test: syncobj_basic
results: parsing output: 73/ for test: gem_mmap_wc
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: kms_plane_scaling
results: parsing output: 76/ for test: gem_mmap_offset
results: parsing output: 77/ for test: kms_big_fb
results: parsing output: 78/ for test: kms_big_fb
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: kms_chamelium_color
results: parsing output: 81/ for test: kms_psr2_sf
results: parsing output: 82/ for test: i915_pm_rpm
results: parsing output: 83/ for test: gem_lmem_swapping
results: parsing output: 84/ for test: syncobj_wait
results: parsing output: 85/ for test: gem_mmap_wc
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: syncobj_timeline
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_psr
results: parsing output: 91/ for test: kms_vrr
results: parsing output: 92/ for test: api_intel_bb
results: parsing output: 93/ for test: gem_exec_fence
results: parsing output: 94/ for test: kms_psr
results: parsing output: 95/ for test: kms_cursor_crc
results: parsing output: 96/ for test: gem_userptr_blits
results: parsing output: 97/ for test: gem_mmap_wc
results: parsing output: 98/ for test: kms_plane
results: parsing output: 99/ for test: kms_pm_rpm
results: parsing output: 100/ for test: kms_universal_plane
results: parsing output: 101/ for test: sw_sync
results: parsing output: 102/ for test: gem_fence_thrash
results: parsing output: 103/ for test: gem_exec_whisper
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: gem_ctx_param
results: parsing output: 107/ for test: kms_big_fb
results: parsing output: 108/ for test: syncobj_timeline
results: parsing output: 109/ for test: kms_cursor_crc
results: parsing output: 110/ for test: gem_softpin
results: parsing output: 111/ for test: kms_flip_scaled_crc
results: parsing output: 112/ for test: syncobj_timeline
results: parsing output: 113/ for test: kms_invalid_mode
results: parsing output: 114/ for test: kms_plane_scaling
results: parsing output: 115/ for test: gem_exec_params
results: parsing output: 116/ for test: gem_madvise
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: kms_cursor_legacy
results: parsing output: 119/ for test: kms_big_fb
results: parsing output: 120/ for test: kms_ccs
results: parsing output: 121/ for test: sriov_basic
results: parsing output: 122/ for test: kms_flip
results: parsing output: 123/ for test: gem_exec_flush
results: parsing output: 124/ for test: kms_addfb_basic
results: parsing output: 125/ for test: kms_flip
results: parsing output: 126/ for test: kms_ccs
results: parsing output: 127/ for test: kms_atomic
results: parsing output: 128/ for test: gem_exec_flush
results: parsing output: 129/ for test: syncobj_wait
results: parsing output: 130/ for test: kms_vblank
results: parsing output: 131/ for test: kms_properties
Done.