[60.420404] Initializing watchdogs [60.420451] /dev/watchdog0 [60.434262] [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] [60.438600] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [60.441169] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [60.444634] [001/131] (960s left) kms_tiled_display (basic-test-pattern-with-chamelium) [60.587688] Subtest basic-test-pattern-with-chamelium: SKIP (0.000s) [60.631223] [002/131] (960s left) gem_ctx_isolation (clean) [60.695791] Starting subtest: clean [60.698053] Starting dynamic subtest: rcs0 [60.749336] Dynamic subtest rcs0: SUCCESS (0.056s) [60.759233] Starting dynamic subtest: bcs0 [60.816092] Dynamic subtest bcs0: SUCCESS (0.066s) [60.824631] Starting dynamic subtest: vcs0 [60.878097] Dynamic subtest vcs0: SUCCESS (0.061s) [60.886655] Starting dynamic subtest: vcs1 [62.287692] Dynamic subtest vcs1: SUCCESS (1.409s) [62.298256] Starting dynamic subtest: vecs0 [64.350990] Dynamic subtest vecs0: SUCCESS (2.064s) [64.358062] Starting dynamic subtest: ccs0 [66.329930] Dynamic subtest ccs0: SUCCESS (1.979s) [66.332294] Subtest clean: SUCCESS (5.637s) [66.557431] [003/131] (954s left) syncobj_timeline (reset-unsignaled) [66.615039] Starting subtest: reset-unsignaled [66.617483] Subtest reset-unsignaled: SUCCESS (0.000s) [66.695664] [004/131] (954s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-wc) [66.798685] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-wc [70.990959] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (4.197s) [72.164970] [005/131] (948s left) sysfs_heartbeat_interval (mixed) [72.250070] Starting subtest: mixed [72.252301] Starting dynamic subtest: vecs0 [77.521087] Dynamic subtest vecs0: SUCCESS (5.273s) [77.536981] Starting dynamic subtest: ccs0 [82.716036] Dynamic subtest ccs0: SUCCESS (5.194s) [82.725769] Starting dynamic subtest: vcs0 [87.949732] Dynamic subtest vcs0: SUCCESS (5.232s) [87.959823] Starting dynamic subtest: bcs0 [93.157989] Dynamic subtest bcs0: SUCCESS (5.208s) [93.167722] Starting dynamic subtest: rcs0 [98.350946] Dynamic subtest rcs0: SUCCESS (5.192s) [98.360791] Starting dynamic subtest: vcs1 [103.550411] Dynamic subtest vcs1: SUCCESS (5.198s) [103.552826] Subtest mixed: SUCCESS (31.303s) [103.621355] [006/131] (917s left) gem_exec_reloc (basic-wc-gtt-noreloc) [103.686160] Subtest basic-wc-gtt-noreloc: SKIP (0.000s) [103.740163] [007/131] (917s left) gem_userptr_blits (invalid-null-pointer) [103.810310] Starting subtest: invalid-null-pointer [103.812332] Subtest invalid-null-pointer: SUCCESS (0.001s) [103.934390] [008/131] (917s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-move) [104.026359] Starting subtest: psr-2p-primscrn-spr-indfb-move [104.030866] Subtest psr-2p-primscrn-spr-indfb-move: SKIP (0.000s) [104.127729] [009/131] (917s left) i915_pm_rps (engine-order) [104.184899] Starting subtest: engine-order [109.243795] Subtest engine-order: SUCCESS (5.059s) [109.379542] [010/131] (911s left) vgem_basic (debugfs) [109.487585] Starting subtest: debugfs [109.489601] Subtest debugfs: SUCCESS (0.000s) [109.546458] [FACT vgem_basic (debugfs)] new: kernel.kmod_is_loaded.vgem: true [109.549698] [011/131] (911s left) kms_psr (fbc-psr-sprite-mmap-cpu) [109.645954] Starting subtest: fbc-psr-sprite-mmap-cpu [109.648220] Starting dynamic subtest: eDP-1 [109.652745] Dynamic subtest eDP-1: SKIP (0.000s) [109.657320] Subtest fbc-psr-sprite-mmap-cpu: SKIP (0.000s) [109.730786] [012/131] (911s left) kms_cursor_edge_walk (64x64-left-edge) [109.821766] Starting subtest: 64x64-left-edge [109.824087] Starting dynamic subtest: pipe-A-eDP-1 [113.292088] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.470s) [113.301330] Starting dynamic subtest: pipe-D-eDP-1 [116.421267] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.129s) [116.423603] Subtest 64x64-left-edge: SUCCESS (6.601s) [117.235879] [013/131] (904s left) syncobj_timeline (etime-single-wait-available-unsubmitted) [117.295896] Starting subtest: etime-single-wait-available-unsubmitted [117.401846] Subtest etime-single-wait-available-unsubmitted: SUCCESS (0.105s) [117.489144] [014/131] (903s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-upscaling) [117.581728] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-upscaling [117.585821] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-upscaling: SKIP (0.000s) [117.650819] [015/131] (903s left) gem_gpgpu_fill (basic) [117.703765] Starting subtest: basic [117.706025] Starting dynamic subtest: smem [117.710654] Dynamic subtest smem: SUCCESS (0.007s) [117.712523] Subtest basic: SUCCESS (0.007s) [117.848897] [016/131] (903s left) kms_flip (basic-flip-vs-wf_vblank) [117.944676] Starting subtest: basic-flip-vs-wf_vblank [117.947074] Starting dynamic subtest: A-eDP1 [119.866149] Dynamic subtest A-eDP1: SUCCESS (1.921s) [119.880188] Starting dynamic subtest: B-eDP1 [121.797768] Dynamic subtest B-eDP1: SUCCESS (1.931s) [121.806238] Starting dynamic subtest: C-eDP1 [123.720618] Dynamic subtest C-eDP1: SUCCESS (1.921s) [123.728558] Starting dynamic subtest: D-eDP1 [125.658042] Dynamic subtest D-eDP1: SUCCESS (1.937s) [125.660355] Subtest basic-flip-vs-wf_vblank: SUCCESS (7.717s) [126.806384] [017/131] (894s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-gtt) [126.918684] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-gtt [126.923251] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [127.018800] [018/131] (894s left) gem_exec_capture (pi) [127.076412] Starting subtest: pi [127.078842] Starting dynamic subtest: rcs0 [131.118561] Dynamic subtest rcs0: SUCCESS (4.042s) [131.128051] Starting dynamic subtest: bcs0 [135.022712] Dynamic subtest bcs0: SUCCESS (3.903s) [135.036885] Starting dynamic subtest: vcs0 [138.868233] Dynamic subtest vcs0: SUCCESS (3.845s) [138.879024] Starting dynamic subtest: vcs1 [142.758108] Dynamic subtest vcs1: SUCCESS (3.889s) [142.769833] Starting dynamic subtest: vecs0 [146.698928] Dynamic subtest vecs0: SUCCESS (3.940s) [146.707439] Starting dynamic subtest: ccs0 [150.600590] Dynamic subtest ccs0: SUCCESS (3.901s) [150.603024] Subtest pi: SUCCESS (23.524s) [150.714562] [019/131] (870s left) gen7_exec_parse (basic-rejected) [150.815457] Subtest basic-rejected: SKIP (0.000s) [150.885546] [020/131] (870s left) gem_exec_schedule (preempt-hang) [151.079909] Starting subtest: preempt-hang [151.082268] Starting dynamic subtest: rcs0 [151.330316] Dynamic subtest rcs0: SUCCESS (0.252s) [151.341612] Starting dynamic subtest: bcs0 [151.574508] Dynamic subtest bcs0: SUCCESS (0.244s) [151.585999] Starting dynamic subtest: vcs0 [151.794382] Dynamic subtest vcs0: SUCCESS (0.220s) [151.806629] Starting dynamic subtest: vcs1 [152.018403] Dynamic subtest vcs1: SUCCESS (0.224s) [152.029546] Starting dynamic subtest: vecs0 [152.239965] Dynamic subtest vecs0: SUCCESS (0.220s) [152.253315] Starting dynamic subtest: ccs0 [152.473494] Dynamic subtest ccs0: SUCCESS (0.234s) [152.475811] Subtest preempt-hang: SUCCESS (1.397s) [153.377550] [021/131] (868s left) kms_big_fb (4-tiled-16bpp-rotate-270) [153.487424] Starting subtest: 4-tiled-16bpp-rotate-270 [153.507230] Subtest 4-tiled-16bpp-rotate-270: SKIP (0.019s) [153.608626] [022/131] (868s left) api_intel_bb (object-noreloc-keep-cache-simple) [153.663733] Starting subtest: object-noreloc-keep-cache-simple [153.668422] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.006s) [153.799781] [023/131] (868s left) kms_lease (lease-unleased-connector) [153.885972] Starting subtest: lease-unleased-connector [153.888278] Starting dynamic subtest: pipe-A-eDP-1 [153.890611] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.006s) [153.901901] Starting dynamic subtest: pipe-B-eDP-1 [153.904126] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.006s) [153.912737] Starting dynamic subtest: pipe-C-eDP-1 [153.915362] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.008s) [153.923503] Starting dynamic subtest: pipe-D-eDP-1 [153.925371] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.007s) [153.927150] Subtest lease-unleased-connector: SUCCESS (0.030s) [154.032460] [024/131] (867s left) gem_mmap_wc (copy) [154.088234] Subtest copy: SKIP (0.000s) [154.146731] [025/131] (867s left) gem_render_copy (mixed-tiled-to-yf-tiled-ccs) [154.204038] Starting subtest: mixed-tiled-to-yf-tiled-ccs [154.208204] Subtest mixed-tiled-to-yf-tiled-ccs: SKIP (0.000s) [154.412824] [026/131] (867s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area) [154.514774] Starting subtest: pr-primary-plane-update-sf-dmg-area [154.519236] Subtest pr-primary-plane-update-sf-dmg-area: SKIP (0.000s) [154.578866] [027/131] (867s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt) [154.678440] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt [154.682956] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [154.780107] [028/131] (867s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt) [154.880845] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt [154.885381] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s) [154.979254] [029/131] (867s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-gtt) [155.073320] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-gtt [155.077725] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [155.182627] [030/131] (866s left) gem_exec_whisper (basic-queues) [155.243357] Starting subtest: basic-queues [161.249711] Subtest basic-queues: SUCCESS (6.002s) [161.433933] [031/131] (860s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-pwrite) [161.543713] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-pwrite [167.738287] Subtest fbc-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (6.198s) [168.907349] [032/131] (853s left) vgem_basic (second-client) [168.963376] Starting subtest: second-client [168.983992] Subtest second-client: SUCCESS (0.022s) [169.073208] [033/131] (853s left) kms_big_fb (y-tiled-8bpp-rotate-90) [169.186723] Starting subtest: y-tiled-8bpp-rotate-90 [169.191295] Subtest y-tiled-8bpp-rotate-90: SKIP (0.000s) [169.279366] [034/131] (853s left) kms_ccs (bad-rotation-90-4-tiled-lnl-ccs) [169.374116] Starting subtest: bad-rotation-90-4-tiled-lnl-ccs [169.378771] Subtest bad-rotation-90-4-tiled-lnl-ccs: SKIP (0.000s) [170.504828] [035/131] (851s left) kms_busy (extended-modeset-hang-newfb-with-reset) [170.618613] Starting subtest: extended-modeset-hang-newfb-with-reset [170.621047] Starting dynamic subtest: pipe-A [184.315303] Dynamic subtest pipe-A: SUCCESS (13.695s) [184.326469] Starting dynamic subtest: pipe-D [200.223579] Dynamic subtest pipe-D: SUCCESS (15.905s) [200.225864] Subtest extended-modeset-hang-newfb-with-reset: SUCCESS (29.603s) [201.021981] [036/131] (821s left) kms_setmode (basic) [201.082590] Starting subtest: basic [201.404768] Starting dynamic subtest: pipe-A-eDP-1 [203.536577] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.128s) [203.882266] Starting dynamic subtest: pipe-B-eDP-1 [205.970312] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.092s) [206.277703] Subtest basic: SUCCESS (5.191s) [207.124128] [037/131] (815s left) kms_frontbuffer_tracking (psr-shrfb-scaledprimary) [207.223640] Starting subtest: psr-shrfb-scaledprimary [212.998366] Subtest psr-shrfb-scaledprimary: SUCCESS (5.777s) [213.123121] [038/131] (809s left) gem_exec_fence (syncobj-timeline-signal) [213.673233] Starting subtest: syncobj-timeline-signal [213.678966] Subtest syncobj-timeline-signal: SUCCESS (0.007s) [215.376967] [039/131] (807s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier) [215.492046] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier [215.496500] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier: SKIP (0.000s) [215.561490] [040/131] (806s left) kms_plane_scaling (planes-downscale-factor-0-5-unity-scaling) [215.667606] Starting subtest: planes-downscale-factor-0-5-unity-scaling [215.669808] Starting dynamic subtest: pipe-A [215.688985] Dynamic subtest pipe-A: SKIP (0.017s) [215.698771] Starting dynamic subtest: pipe-B [215.717386] Dynamic subtest pipe-B: SKIP (0.029s) [215.726970] Starting dynamic subtest: pipe-C [215.748055] Dynamic subtest pipe-C: SKIP (0.030s) [215.757782] Starting dynamic subtest: pipe-D [215.779589] Dynamic subtest pipe-D: SKIP (0.031s) [215.783256] Subtest planes-downscale-factor-0-5-unity-scaling: SKIP (0.109s) [215.881969] [041/131] (806s left) drm_read (empty-block) [216.022021] Starting subtest: empty-block [217.023105] Subtest empty-block: SUCCESS (1.001s) [217.172997] [042/131] (805s left) kms_draw_crc (draw-method-mmap-gtt) [217.271369] Starting subtest: draw-method-mmap-gtt [217.275808] Subtest draw-method-mmap-gtt: SKIP (0.000s) [217.369137] [043/131] (805s left) kms_cursor_crc (cursor-rapid-movement-32x10) [217.549425] Starting subtest: cursor-rapid-movement-32x10 [217.597283] Subtest cursor-rapid-movement-32x10: SKIP (0.042s) [217.894756] [044/131] (804s left) gem_exec_balancer (nohangcheck) [218.157925] Starting subtest: nohangcheck [219.068914] Subtest nohangcheck: SUCCESS (0.910s) [219.179988] [045/131] (803s left) gem_mmap_gtt (basic-write-cpu-read-gtt) [219.241164] Subtest basic-write-cpu-read-gtt: SKIP (0.000s) [219.303641] [046/131] (803s left) gen9_exec_parse (unaligned-jump) [219.375849] Subtest unaligned-jump: SKIP (0.000s) [219.446155] [047/131] (803s left) syncobj_timeline (transfer-timeline-point) [219.497154] Starting subtest: transfer-timeline-point [219.499562] Subtest transfer-timeline-point: SUCCESS (0.001s) [219.601676] [048/131] (803s left) kms_plane (pixel-format-4-tiled-modifier-source-clamping) [219.689337] Starting subtest: pixel-format-4-tiled-modifier-source-clamping [219.715423] Starting dynamic subtest: pipe-A-plane-0 [220.370365] Dynamic subtest pipe-A-plane-0: SUCCESS (0.655s) [220.379535] Starting dynamic subtest: pipe-A-plane-3 [220.771729] Dynamic subtest pipe-A-plane-3: SUCCESS (0.399s) [221.923831] Starting dynamic subtest: pipe-B-plane-0 [222.604330] Dynamic subtest pipe-B-plane-0: SUCCESS (0.689s) [222.615545] Starting dynamic subtest: pipe-B-plane-3 [223.048881] Dynamic subtest pipe-B-plane-3: SUCCESS (0.443s) [223.359636] Subtest pixel-format-4-tiled-modifier-source-clamping: SUCCESS (3.670s) [224.209992] [049/131] (798s left) kms_vblank (query-forked) [224.302865] Starting subtest: query-forked [224.304755] Starting dynamic subtest: pipe-A-eDP-1 [226.123488] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.822s) [226.143623] Starting dynamic subtest: pipe-D-eDP-1 [228.599741] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.473s) [228.602072] Subtest query-forked: SUCCESS (4.298s) [229.460695] [050/131] (793s left) kms_chamelium_frames (hdmi-frame-dump) [229.839601] Subtest hdmi-frame-dump: SKIP (0.000s) [230.670159] [051/131] (792s left) syncobj_wait (invalid-multi-wait-unsubmitted) [230.730890] Starting subtest: invalid-multi-wait-unsubmitted [230.733225] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s) [230.820348] [052/131] (792s left) kms_psr (pr-primary-page-flip) [230.903967] Starting subtest: pr-primary-page-flip [230.908230] Subtest pr-primary-page-flip: SKIP (0.000s) [230.990708] [053/131] (792s left) vgem_basic (mmap) [231.039885] Starting subtest: mmap [231.048430] Subtest mmap: SUCCESS (0.010s) [231.109868] [054/131] (792s left) kms_content_protection (dp-mst-lic-type-0) [231.247667] Starting subtest: dp-mst-lic-type-0 [231.251961] Subtest dp-mst-lic-type-0: SKIP (0.000s) [231.373510] [055/131] (791s left) kms_hdr (bpc-switch-dpms) [231.465225] Starting subtest: bpc-switch-dpms [232.571264] Starting dynamic subtest: pipe-A-eDP-1 [237.074203] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.506s) [237.076492] Subtest bpc-switch-dpms: SUCCESS (5.612s) [237.191309] [056/131] (786s left) kms_joiner (invalid-modeset-big-joiner) [237.294556] Starting subtest: invalid-modeset-big-joiner [237.298671] Subtest invalid-modeset-big-joiner: SKIP (0.000s) [237.359882] [057/131] (785s left) gem_exec_reloc (basic-wc-gtt-active) [237.426256] Subtest basic-wc-gtt-active: SKIP (0.000s) [237.490627] [058/131] (785s left) gem_partial_pwrite_pread (reads-uncached) [237.538483] Subtest reads-uncached: SKIP (0.000s) [237.605355] [059/131] (785s left) gem_close_race (basic-threads) [237.666253] Starting subtest: basic-threads [239.082128] Subtest basic-threads: SUCCESS (1.419s) [239.269376] [060/131] (784s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-gtt) [239.370250] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-gtt [239.374411] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [239.477597] [061/131] (783s left) prime_self_import (reimport-vs-gem_close-race) [239.517974] Starting subtest: reimport-vs-gem_close-race [244.614229] Subtest reimport-vs-gem_close-race: SUCCESS (5.096s) [244.692895] [062/131] (778s left) gem_spin_batch (resubmit-new) [244.756738] Starting subtest: resubmit-new [244.759186] Starting dynamic subtest: rcs0 [244.767615] Dynamic subtest rcs0: SUCCESS (0.011s) [244.778321] Starting dynamic subtest: bcs0 [244.780572] Dynamic subtest bcs0: SUCCESS (0.006s) [244.790795] Starting dynamic subtest: vcs0 [244.792668] Dynamic subtest vcs0: SUCCESS (0.007s) [244.805723] Starting dynamic subtest: vcs1 [244.808463] Dynamic subtest vcs1: SUCCESS (0.007s) [244.817404] Starting dynamic subtest: vecs0 [244.819205] Dynamic subtest vecs0: SUCCESS (0.009s) [244.827674] Starting dynamic subtest: ccs0 [244.829666] Dynamic subtest ccs0: SUCCESS (0.009s) [244.831532] Subtest resubmit-new: SUCCESS (0.051s) [246.325217] [063/131] (777s left) gem_exec_schedule (thriceslice) [246.405745] Starting subtest: thriceslice [246.408204] Starting dynamic subtest: rcs0 [246.453203] Dynamic subtest rcs0: SUCCESS (0.057s) [246.466626] Starting dynamic subtest: bcs0 [246.513638] Dynamic subtest bcs0: SUCCESS (0.058s) [246.525785] Starting dynamic subtest: vcs0 [246.548859] Dynamic subtest vcs0: SUCCESS (0.035s) [246.561693] Starting dynamic subtest: vcs1 [246.612855] Dynamic subtest vcs1: SUCCESS (0.062s) [246.624519] Starting dynamic subtest: vecs0 [246.647243] Dynamic subtest vecs0: SUCCESS (0.033s) [246.656786] Starting dynamic subtest: ccs0 [246.702846] Dynamic subtest ccs0: SUCCESS (0.054s) [246.705404] Subtest thriceslice: SUCCESS (0.309s) [247.010424] [064/131] (776s left) kms_ccs (random-ccs-data-4-tiled-mtl-mc-ccs) [247.108079] Starting subtest: random-ccs-data-4-tiled-mtl-mc-ccs [247.110239] Starting dynamic subtest: pipe-A-eDP-1 [248.317913] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.211s) [248.327645] Starting dynamic subtest: pipe-B-eDP-1 [250.660444] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.341s) [250.670379] Starting dynamic subtest: pipe-C-eDP-1 [252.977268] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.316s) [252.987916] Starting dynamic subtest: pipe-D-eDP-1 [255.331654] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.353s) [255.333978] Subtest random-ccs-data-4-tiled-mtl-mc-ccs: SUCCESS (8.226s) [256.458390] [065/131] (767s left) gem_ctx_engines (execute-one) [256.516390] Starting subtest: execute-one [258.765693] Subtest execute-one: SUCCESS (2.250s) [259.301373] [066/131] (764s left) i915_hangman (engine-engine-hang) [259.357869] Starting subtest: engine-engine-hang [259.360016] Starting dynamic subtest: rcs0 [261.276615] Dynamic subtest rcs0: SUCCESS (1.918s) [261.288959] Starting dynamic subtest: bcs0 [263.259241] Dynamic subtest bcs0: SUCCESS (1.981s) [263.271480] Starting dynamic subtest: vcs0 [265.244430] Dynamic subtest vcs0: SUCCESS (1.983s) [265.257098] Starting dynamic subtest: vcs1 [267.291968] Dynamic subtest vcs1: SUCCESS (2.045s) [267.304283] Starting dynamic subtest: vecs0 [269.277562] Dynamic subtest vecs0: SUCCESS (1.982s) [269.290035] Starting dynamic subtest: ccs0 [271.260462] Dynamic subtest ccs0: SUCCESS (1.980s) [271.263971] Subtest engine-engine-hang: SUCCESS (11.904s) [271.398971] [067/131] (752s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip) [271.498138] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip [272.322293] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SUCCESS (0.825s) [272.484246] [068/131] (751s left) gem_lmem_swapping (parallel-random-verify-ccs) [272.531087] Subtest parallel-random-verify-ccs: SKIP (0.000s) [272.578183] [069/131] (751s left) kms_debugfs (display-on-read-all) [272.680837] Starting subtest: display-on-read-all [272.846361] Subtest display-on-read-all: SUCCESS (0.167s) [272.955069] [070/131] (750s left) kms_psr (psr2-sprite-blt) [273.053106] Starting subtest: psr2-sprite-blt [273.055304] Starting dynamic subtest: eDP-1 [274.747475] Dynamic subtest eDP-1: SUCCESS (1.696s) [274.749845] Subtest psr2-sprite-blt: SUCCESS (1.697s) [275.610580] [071/131] (748s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc) [275.722709] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc [275.726905] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [275.814365] [072/131] (748s left) kms_big_fb (yf-tiled-64bpp-rotate-90) [275.909640] Starting subtest: yf-tiled-64bpp-rotate-90 [275.913836] Subtest yf-tiled-64bpp-rotate-90: SKIP (0.000s) [276.018166] [073/131] (747s left) kms_chamelium_hpd (hdmi-hpd-enable-disable-mode) [276.399400] Subtest hdmi-hpd-enable-disable-mode: SKIP (0.000s) [277.218988] [074/131] (746s left) gem_ctx_param (basic-default) [277.277533] Starting subtest: basic-default [277.280056] Subtest basic-default: SUCCESS (0.000s) [277.352546] [075/131] (746s left) kms_cursor_crc (cursor-onscreen-max-size) [277.653752] Starting subtest: cursor-onscreen-max-size [277.660641] Subtest cursor-onscreen-max-size: SKIP (0.000s) [277.799157] [076/131] (746s left) kms_flip (2x-plain-flip-ts-check) [277.892058] Starting subtest: 2x-plain-flip-ts-check [277.900649] Subtest 2x-plain-flip-ts-check: SKIP (0.010s) [277.976019] [077/131] (746s left) sriov_basic (enable-vfs-bind-unbind-each) [278.031532] Starting subtest: enable-vfs-bind-unbind-each [278.033818] Starting dynamic subtest: numvfs-1 [278.116282] Dynamic subtest numvfs-1: FAIL (0.030s) [278.127493] Starting dynamic subtest: numvfs-2 [278.193028] Dynamic subtest numvfs-2: FAIL (0.003s) [278.203478] Starting dynamic subtest: numvfs-3 [278.266171] Dynamic subtest numvfs-3: FAIL (0.003s) [278.277706] Starting dynamic subtest: numvfs-4 [278.337686] Dynamic subtest numvfs-4: FAIL (0.003s) [278.347930] Starting dynamic subtest: numvfs-5 [278.408064] Dynamic subtest numvfs-5: FAIL (0.003s) [278.418664] Starting dynamic subtest: numvfs-6 [278.478408] Dynamic subtest numvfs-6: FAIL (0.003s) [278.487999] Starting dynamic subtest: numvfs-7 [278.548768] Dynamic subtest numvfs-7: FAIL (0.003s) [278.559062] Starting dynamic subtest: numvfs-random [278.617980] Dynamic subtest numvfs-random: FAIL (0.003s) [278.620036] Subtest enable-vfs-bind-unbind-each: FAIL (0.059s) [278.658036] [078/131] (745s left) kms_pm_rpm (modeset-non-lpsp-stress-no-wait) [280.499051] Starting subtest: modeset-non-lpsp-stress-no-wait [280.559060] Subtest modeset-non-lpsp-stress-no-wait: SKIP (0.061s) [280.973769] [079/131] (743s left) template (a) [281.026049] Starting subtest: A [281.028220] Subtest A: SUCCESS (0.000s) [281.110784] [080/131] (743s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted-signal [281.164707] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted-signaled [281.266220] Subtest etime-multi-wait-all-available-unsubmitted-submitted-signaled: SUCCESS (0.102s) [281.343119] [081/131] (742s left) gem_exec_params (invalid-bsd1-flag-on-blt) [281.399356] Starting subtest: invalid-bsd1-flag-on-blt [281.401625] Subtest invalid-bsd1-flag-on-blt: SUCCESS (0.000s) [281.501436] [082/131] (742s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-blt) [281.595576] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-blt [288.365513] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (6.772s) [288.523906] [083/131] (735s left) gem_exec_fence (submit3) [288.703060] Starting subtest: submit3 [288.707814] Subtest submit3: SKIP (0.000s) [290.372970] [084/131] (733s left) kms_rotation_crc (primary-rotation-180) [290.462031] Starting subtest: primary-rotation-180 [297.425093] Subtest primary-rotation-180: SUCCESS (6.965s) [298.654842] [085/131] (725s left) kms_ccs (crc-primary-suspend-y-tiled-ccs) [298.750315] Starting subtest: crc-primary-suspend-y-tiled-ccs [298.752639] Starting dynamic subtest: pipe-A-eDP-1 [298.761874] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [298.773155] Starting dynamic subtest: pipe-B-eDP-1 [298.782404] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [298.792120] Starting dynamic subtest: pipe-C-eDP-1 [298.800964] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [298.812062] Starting dynamic subtest: pipe-D-eDP-1 [298.820262] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [298.824463] Subtest crc-primary-suspend-y-tiled-ccs: SKIP (0.004s) [300.926920] [086/131] (723s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled) [300.983058] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled [300.985407] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s) [301.067375] [087/131] (723s left) gem_pread (uncached) [301.125262] Subtest uncached: SKIP (0.000s) [301.188032] [088/131] (723s left) syncobj_timeline (invalid-signal-one-illegal-handle) [301.234627] Starting subtest: invalid-signal-one-illegal-handle [301.236721] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s) [301.324562] [089/131] (723s left) gem_ctx_persistence (heartbeat-many) [301.394358] Starting subtest: heartbeat-many [301.398803] Subtest heartbeat-many: SKIP (0.000s) [301.509520] [090/131] (723s left) kms_plane (plane-panning-bottom-right) [301.601313] Starting subtest: plane-panning-bottom-right [301.603277] Starting dynamic subtest: pipe-A [303.316623] Dynamic subtest pipe-A: SUCCESS (1.713s) [303.326734] Starting dynamic subtest: pipe-B [305.737136] Dynamic subtest pipe-B: SUCCESS (2.422s) [305.739432] Subtest plane-panning-bottom-right: SUCCESS (4.137s) [306.578449] [091/131] (718s left) kms_plane_alpha_blend (coverage-7efc) [306.675072] Starting subtest: coverage-7efc [307.067994] Starting dynamic subtest: pipe-A-eDP-1 [307.691299] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.623s) [307.744164] Starting dynamic subtest: pipe-D-eDP-1 [309.002049] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.267s) [309.004471] Subtest coverage-7efc: SUCCESS (2.326s) [309.833873] [092/131] (714s left) perf (gen12-group-concurrent-oa-buffer-read) [309.964369] Starting subtest: gen12-group-concurrent-oa-buffer-read [319.997106] Subtest gen12-group-concurrent-oa-buffer-read: SUCCESS (10.030s) [320.044883] [093/131] (704s left) kms_color (degamma) [320.144078] Starting subtest: degamma [320.146408] Starting dynamic subtest: pipe-A-eDP-1 [320.855768] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.710s) [320.865848] Starting dynamic subtest: pipe-B-eDP-1 [322.258909] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.402s) [322.268740] Starting dynamic subtest: pipe-C-eDP-1 [323.668075] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.408s) [323.682707] Starting dynamic subtest: pipe-D-eDP-1 [325.059289] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.389s) [325.061126] Subtest degamma: SUCCESS (4.913s) [325.883418] [094/131] (698s left) gem_vm_create (create-ext) [325.947685] Starting subtest: create-ext [325.953706] Subtest create-ext: SUCCESS (0.006s) [326.065749] [095/131] (698s left) gem_ctx_param (root-set) [326.112835] Starting subtest: root-set [326.115303] Subtest root-set: SUCCESS (0.001s) [326.219195] [096/131] (698s left) gem_mmap_gtt (flink-race) [326.263314] Subtest flink-race: SKIP (0.000s) [326.329605] [097/131] (698s left) kms_big_fb (yf-tiled-32bpp-rotate-0) [326.422934] Starting subtest: yf-tiled-32bpp-rotate-0 [326.427452] Subtest yf-tiled-32bpp-rotate-0: SKIP (0.000s) [326.519980] [098/131] (698s left) core_setmaster (master-drop-set-root) [326.595110] Starting subtest: master-drop-set-root [326.622616] Subtest master-drop-set-root: SUCCESS (0.024s) [326.672596] [099/131] (698s left) gem_exec_reloc (basic-cpu-read-noreloc) [326.726653] Subtest basic-cpu-read-noreloc: SKIP (0.000s) [326.800803] [100/131] (698s left) kms_psr (fbc-psr2-primary-page-flip) [326.895934] Starting subtest: fbc-psr2-primary-page-flip [326.897991] Starting dynamic subtest: eDP-1 [326.901818] Dynamic subtest eDP-1: SKIP (0.000s) [326.905449] Subtest fbc-psr2-primary-page-flip: SKIP (0.001s) [326.968808] [101/131] (698s left) kms_psr (psr-primary-mmap-gtt) [327.053125] Starting subtest: psr-primary-mmap-gtt [327.054973] Starting dynamic subtest: eDP-1 [328.485063] Dynamic subtest eDP-1: SKIP (1.428s) [328.489785] Subtest psr-primary-mmap-gtt: SKIP (1.431s) [328.621887] [102/131] (696s left) gem_workarounds (reset) [328.681475] Starting subtest: reset [328.867874] Subtest reset: SUCCESS (0.186s) [328.975759] [103/131] (696s left) gem_sync (basic-store-each) [329.045356] Starting subtest: basic-store-each [331.471775] Subtest basic-store-each: SUCCESS (2.436s) [331.660382] [104/131] (693s left) api_intel_allocator (open-vm) [331.723401] Starting subtest: open-vm [331.726762] Subtest open-vm: SUCCESS (0.006s) [331.862688] [105/131] (693s left) kms_flip_tiling (flip-change-tiling) [331.958032] Starting subtest: flip-change-tiling [331.960572] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4-mc-ccs [332.133916] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (0.176s) [332.146740] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs [332.268346] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.131s) [332.283360] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs-cc [332.402166] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.132s) [332.416962] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4 [332.544741] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4: SUCCESS (0.141s) [332.557877] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-x [332.689252] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-x: SUCCESS (0.142s) [332.701945] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-linear [332.822256] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.131s) [332.834280] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4-mc-ccs [332.967402] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.142s) [332.979452] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs [333.078250] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.109s) [333.090717] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs-cc [333.213227] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.131s) [333.226389] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4 [333.356471] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4: SUCCESS (0.142s) [333.369269] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-x [333.500064] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-x: SUCCESS (0.142s) [333.516437] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-linear [333.649671] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.146s) [333.662818] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4-mc-ccs [333.761598] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.109s) [333.772792] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs [333.872694] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.109s) [333.885387] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc [333.972626] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.098s) [333.985691] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4 [334.106032] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.132s) [334.119072] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-x [334.249925] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.142s) [334.263530] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-linear [334.394046] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.142s) [334.406064] Starting dynamic subtest: pipe-A-eDP-1-4-to-4-mc-ccs [334.528057] Dynamic subtest pipe-A-eDP-1-4-to-4-mc-ccs: SUCCESS (0.131s) [334.540516] Starting dynamic subtest: pipe-A-eDP-1-4-to-4-rc-ccs [334.672040] Dynamic subtest pipe-A-eDP-1-4-to-4-rc-ccs: SUCCESS (0.142s) [334.684468] Starting dynamic subtest: pipe-A-eDP-1-4-to-4-rc-ccs-cc [334.805210] Dynamic subtest pipe-A-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.131s) [334.817704] Starting dynamic subtest: pipe-A-eDP-1-4-to-4 [334.927337] Dynamic subtest pipe-A-eDP-1-4-to-4: SUCCESS (0.120s) [334.938572] Starting dynamic subtest: pipe-A-eDP-1-4-to-x [335.072091] Dynamic subtest pipe-A-eDP-1-4-to-x: SUCCESS (0.142s) [335.083767] Starting dynamic subtest: pipe-A-eDP-1-4-to-linear [335.215835] Dynamic subtest pipe-A-eDP-1-4-to-linear: SUCCESS (0.142s) [335.230189] Starting dynamic subtest: pipe-A-eDP-1-x-to-4-mc-ccs [335.361025] Dynamic subtest pipe-A-eDP-1-x-to-4-mc-ccs: SUCCESS (0.142s) [335.373256] Starting dynamic subtest: pipe-A-eDP-1-x-to-4-rc-ccs [335.505829] Dynamic subtest pipe-A-eDP-1-x-to-4-rc-ccs: SUCCESS (0.142s) [335.518338] Starting dynamic subtest: pipe-A-eDP-1-x-to-4-rc-ccs-cc [335.649565] Dynamic subtest pipe-A-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.142s) [335.663752] Starting dynamic subtest: pipe-A-eDP-1-x-to-4 [335.793662] Dynamic subtest pipe-A-eDP-1-x-to-4: SUCCESS (0.142s) [335.807635] Starting dynamic subtest: pipe-A-eDP-1-x-to-x [335.916228] Dynamic subtest pipe-A-eDP-1-x-to-x: SUCCESS (0.120s) [335.926899] Starting dynamic subtest: pipe-A-eDP-1-x-to-linear [336.061062] Dynamic subtest pipe-A-eDP-1-x-to-linear: SUCCESS (0.142s) [336.074546] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4-mc-ccs [336.205162] Dynamic subtest pipe-A-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.142s) [336.225347] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4-rc-ccs [336.349779] Dynamic subtest pipe-A-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.142s) [336.361428] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4-rc-ccs-cc [336.494522] Dynamic subtest pipe-A-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.142s) [336.506631] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4 [336.638468] Dynamic subtest pipe-A-eDP-1-linear-to-4: SUCCESS (0.142s) [336.650594] Starting dynamic subtest: pipe-A-eDP-1-linear-to-x [336.810893] Dynamic subtest pipe-A-eDP-1-linear-to-x: SUCCESS (0.170s) [336.826187] Starting dynamic subtest: pipe-A-eDP-1-linear-to-linear [336.944363] Dynamic subtest pipe-A-eDP-1-linear-to-linear: SUCCESS (0.131s) [337.002564] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4-mc-ccs [338.182060] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.192s) [338.194799] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs [338.316222] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.131s) [338.328752] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs-cc [338.449462] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.131s) [338.462163] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4 [338.592830] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4: SUCCESS (0.142s) [338.605462] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-x [338.725848] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-x: SUCCESS (0.131s) [338.737440] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-linear [338.870660] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.143s) [338.886239] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4-mc-ccs [339.015634] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.142s) [339.028283] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs [339.126226] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.109s) [339.139049] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs-cc [339.260965] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.131s) [339.273854] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4 [339.403859] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4: SUCCESS (0.142s) [339.416223] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-x [339.549078] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-x: SUCCESS (0.142s) [339.563878] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-linear [339.692947] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.142s) [339.711358] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4-mc-ccs [339.826662] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.131s) [339.839736] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs [339.961571] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.132s) [339.974739] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc [340.070712] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.108s) [340.081791] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4 [340.214998] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.142s) [340.231042] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-x [340.359482] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.142s) [340.371432] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-linear [340.503822] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.142s) [340.516271] Starting dynamic subtest: pipe-B-eDP-1-4-to-4-mc-ccs [340.637361] Dynamic subtest pipe-B-eDP-1-4-to-4-mc-ccs: SUCCESS (0.131s) [340.648412] Starting dynamic subtest: pipe-B-eDP-1-4-to-4-rc-ccs [340.781937] Dynamic subtest pipe-B-eDP-1-4-to-4-rc-ccs: SUCCESS (0.142s) [340.794379] Starting dynamic subtest: pipe-B-eDP-1-4-to-4-rc-ccs-cc [340.915515] Dynamic subtest pipe-B-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.131s) [340.928871] Starting dynamic subtest: pipe-B-eDP-1-4-to-4 [341.037046] Dynamic subtest pipe-B-eDP-1-4-to-4: SUCCESS (0.120s) [341.049040] Starting dynamic subtest: pipe-B-eDP-1-4-to-x [341.181641] Dynamic subtest pipe-B-eDP-1-4-to-x: SUCCESS (0.144s) [341.195187] Starting dynamic subtest: pipe-B-eDP-1-4-to-linear [341.325695] Dynamic subtest pipe-B-eDP-1-4-to-linear: SUCCESS (0.142s) [341.338335] Starting dynamic subtest: pipe-B-eDP-1-x-to-4-mc-ccs [341.469909] Dynamic subtest pipe-B-eDP-1-x-to-4-mc-ccs: SUCCESS (0.142s) [341.485389] Starting dynamic subtest: pipe-B-eDP-1-x-to-4-rc-ccs [341.603289] Dynamic subtest pipe-B-eDP-1-x-to-4-rc-ccs: SUCCESS (0.131s) [341.618465] Starting dynamic subtest: pipe-B-eDP-1-x-to-4-rc-ccs-cc [341.736952] Dynamic subtest pipe-B-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.131s) [341.751050] Starting dynamic subtest: pipe-B-eDP-1-x-to-4 [341.881370] Dynamic subtest pipe-B-eDP-1-x-to-4: SUCCESS (0.142s) [341.893650] Starting dynamic subtest: pipe-B-eDP-1-x-to-x [342.003662] Dynamic subtest pipe-B-eDP-1-x-to-x: SUCCESS (0.120s) [342.016233] Starting dynamic subtest: pipe-B-eDP-1-x-to-linear [342.159636] Dynamic subtest pipe-B-eDP-1-x-to-linear: SUCCESS (0.153s) [342.172327] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4-mc-ccs [342.314935] Dynamic subtest pipe-B-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.153s) [342.327144] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4-rc-ccs [342.447764] Dynamic subtest pipe-B-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.131s) [342.463556] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4-rc-ccs-cc [342.592983] Dynamic subtest pipe-B-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.142s) [342.605619] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4 [342.736965] Dynamic subtest pipe-B-eDP-1-linear-to-4: SUCCESS (0.142s) [342.752096] Starting dynamic subtest: pipe-B-eDP-1-linear-to-x [342.881844] Dynamic subtest pipe-B-eDP-1-linear-to-x: SUCCESS (0.142s) [342.894787] Starting dynamic subtest: pipe-B-eDP-1-linear-to-linear [343.003957] Dynamic subtest pipe-B-eDP-1-linear-to-linear: SUCCESS (0.120s) [343.056232] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4-mc-ccs [344.318587] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.269s) [344.331745] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs [344.418628] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.098s) [344.431708] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs-cc [344.518762] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.098s) [344.531619] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4 [344.640781] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4: SUCCESS (0.121s) [344.653776] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-x [344.751430] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-x: SUCCESS (0.109s) [344.763756] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-linear [344.851380] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.098s) [344.862093] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4-mc-ccs [344.951564] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.099s) [344.963697] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs [345.051929] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.098s) [345.063838] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs-cc [345.151507] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.099s) [345.163894] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4 [345.251226] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4: SUCCESS (0.098s) [345.261956] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-x [345.351164] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-x: SUCCESS (0.098s) [345.364525] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-linear [345.462240] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.110s) [345.473259] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4-mc-ccs [345.562578] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.098s) [345.574337] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs [345.662634] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.098s) [345.674653] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc [345.762655] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.098s) [345.774283] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4 [345.862557] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.098s) [345.874146] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-x [345.962108] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.098s) [345.973324] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-linear [346.062146] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.099s) [346.073533] Starting dynamic subtest: pipe-C-eDP-1-4-to-4-mc-ccs [346.173495] Dynamic subtest pipe-C-eDP-1-4-to-4-mc-ccs: SUCCESS (0.110s) [346.185885] Starting dynamic subtest: pipe-C-eDP-1-4-to-4-rc-ccs [346.273859] Dynamic subtest pipe-C-eDP-1-4-to-4-rc-ccs: SUCCESS (0.098s) [346.286158] Starting dynamic subtest: pipe-C-eDP-1-4-to-4-rc-ccs-cc [346.373637] Dynamic subtest pipe-C-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.098s) [346.386033] Starting dynamic subtest: pipe-C-eDP-1-4-to-4 [346.484872] Dynamic subtest pipe-C-eDP-1-4-to-4: SUCCESS (0.109s) [346.497107] Starting dynamic subtest: pipe-C-eDP-1-4-to-x [346.606432] Dynamic subtest pipe-C-eDP-1-4-to-x: SUCCESS (0.120s) [346.618210] Starting dynamic subtest: pipe-C-eDP-1-4-to-linear [346.717795] Dynamic subtest pipe-C-eDP-1-4-to-linear: SUCCESS (0.109s) [346.730362] Starting dynamic subtest: pipe-C-eDP-1-x-to-4-mc-ccs [346.817766] Dynamic subtest pipe-C-eDP-1-x-to-4-mc-ccs: SUCCESS (0.098s) [346.829618] Starting dynamic subtest: pipe-C-eDP-1-x-to-4-rc-ccs [346.917681] Dynamic subtest pipe-C-eDP-1-x-to-4-rc-ccs: SUCCESS (0.099s) [346.933091] Starting dynamic subtest: pipe-C-eDP-1-x-to-4-rc-ccs-cc [347.017756] Dynamic subtest pipe-C-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.099s) [347.029214] Starting dynamic subtest: pipe-C-eDP-1-x-to-4 [347.128670] Dynamic subtest pipe-C-eDP-1-x-to-4: SUCCESS (0.110s) [347.140424] Starting dynamic subtest: pipe-C-eDP-1-x-to-x [347.240499] Dynamic subtest pipe-C-eDP-1-x-to-x: SUCCESS (0.109s) [347.252326] Starting dynamic subtest: pipe-C-eDP-1-x-to-linear [347.351522] Dynamic subtest pipe-C-eDP-1-x-to-linear: SUCCESS (0.109s) [347.364375] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4-mc-ccs [347.450852] Dynamic subtest pipe-C-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.098s) [347.462644] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4-rc-ccs [347.551105] Dynamic subtest pipe-C-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.099s) [347.563723] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4-rc-ccs-cc [347.651127] Dynamic subtest pipe-C-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.099s) [347.662989] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4 [347.762177] Dynamic subtest pipe-C-eDP-1-linear-to-4: SUCCESS (0.110s) [347.778634] Starting dynamic subtest: pipe-C-eDP-1-linear-to-x [347.873663] Dynamic subtest pipe-C-eDP-1-linear-to-x: SUCCESS (0.110s) [347.886674] Starting dynamic subtest: pipe-C-eDP-1-linear-to-linear [347.985037] Dynamic subtest pipe-C-eDP-1-linear-to-linear: SUCCESS (0.109s) [348.026389] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4-mc-ccs [349.250304] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.231s) [349.262486] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs [349.350535] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.098s) [349.362439] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs-cc [349.450470] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.099s) [349.462526] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4 [349.550257] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4: SUCCESS (0.099s) [349.563648] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-x [349.660675] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-x: SUCCESS (0.109s) [349.676067] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-linear [349.810799] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.146s) [349.820793] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4-mc-ccs [349.911225] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.098s) [349.923840] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs [350.010996] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.098s) [350.023895] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs-cc [350.111039] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.097s) [350.125081] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4 [350.210928] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4: SUCCESS (0.099s) [350.223483] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-x [350.359904] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-x: SUCCESS (0.148s) [350.371776] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-linear [350.459907] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.098s) [350.471899] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4-mc-ccs [350.560569] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.098s) [350.572532] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs [350.660928] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.098s) [350.673049] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc [350.760948] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.099s) [350.773072] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4 [350.860463] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.098s) [350.872577] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-x [350.971239] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.109s) [350.983338] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-linear [351.082451] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.109s) [351.100616] Starting dynamic subtest: pipe-D-eDP-1-4-to-4-mc-ccs [351.194413] Dynamic subtest pipe-D-eDP-1-4-to-4-mc-ccs: SUCCESS (0.109s) [351.206928] Starting dynamic subtest: pipe-D-eDP-1-4-to-4-rc-ccs [351.305070] Dynamic subtest pipe-D-eDP-1-4-to-4-rc-ccs: SUCCESS (0.109s) [351.317046] Starting dynamic subtest: pipe-D-eDP-1-4-to-4-rc-ccs-cc [351.404809] Dynamic subtest pipe-D-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.098s) [351.416916] Starting dynamic subtest: pipe-D-eDP-1-4-to-4 [351.516083] Dynamic subtest pipe-D-eDP-1-4-to-4: SUCCESS (0.109s) [351.527994] Starting dynamic subtest: pipe-D-eDP-1-4-to-x [351.627060] Dynamic subtest pipe-D-eDP-1-4-to-x: SUCCESS (0.109s) [351.638527] Starting dynamic subtest: pipe-D-eDP-1-4-to-linear [351.738082] Dynamic subtest pipe-D-eDP-1-4-to-linear: SUCCESS (0.109s) [351.749970] Starting dynamic subtest: pipe-D-eDP-1-x-to-4-mc-ccs [351.839041] Dynamic subtest pipe-D-eDP-1-x-to-4-mc-ccs: SUCCESS (0.098s) [351.857518] Starting dynamic subtest: pipe-D-eDP-1-x-to-4-rc-ccs [351.937787] Dynamic subtest pipe-D-eDP-1-x-to-4-rc-ccs: SUCCESS (0.099s) [351.950220] Starting dynamic subtest: pipe-D-eDP-1-x-to-4-rc-ccs-cc [352.038382] Dynamic subtest pipe-D-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.098s) [352.049319] Starting dynamic subtest: pipe-D-eDP-1-x-to-4 [352.149114] Dynamic subtest pipe-D-eDP-1-x-to-4: SUCCESS (0.110s) [352.161210] Starting dynamic subtest: pipe-D-eDP-1-x-to-x [352.260095] Dynamic subtest pipe-D-eDP-1-x-to-x: SUCCESS (0.109s) [352.274027] Starting dynamic subtest: pipe-D-eDP-1-x-to-linear [352.371915] Dynamic subtest pipe-D-eDP-1-x-to-linear: SUCCESS (0.109s) [352.384595] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4-mc-ccs [352.482190] Dynamic subtest pipe-D-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.109s) [352.494211] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4-rc-ccs [352.583108] Dynamic subtest pipe-D-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.098s) [352.594597] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4-rc-ccs-cc [352.693762] Dynamic subtest pipe-D-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.109s) [352.705381] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4 [352.804919] Dynamic subtest pipe-D-eDP-1-linear-to-4: SUCCESS (0.109s) [352.819821] Starting dynamic subtest: pipe-D-eDP-1-linear-to-x [352.927700] Dynamic subtest pipe-D-eDP-1-linear-to-x: SUCCESS (0.121s) [352.939507] Starting dynamic subtest: pipe-D-eDP-1-linear-to-linear [353.038355] Dynamic subtest pipe-D-eDP-1-linear-to-linear: SUCCESS (0.109s) [353.071372] Subtest flip-change-tiling: SUCCESS (21.114s) [354.237112] [106/131] (671s left) kms_pm_dc (dc6-dpms) [355.335893] Starting subtest: dc6-dpms [357.418058] Subtest dc6-dpms: SUCCESS (2.080s) [357.498462] [107/131] (667s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc) [357.598251] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc [357.600532] Starting dynamic subtest: pipe-A-eDP-1 [357.620332] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s) [357.632078] Starting dynamic subtest: pipe-B-eDP-1 [357.650818] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [357.659915] Starting dynamic subtest: pipe-C-eDP-1 [357.678284] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [357.687256] Starting dynamic subtest: pipe-D-eDP-1 [357.706073] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [357.708161] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.005s) [359.833510] [108/131] (665s left) gem_exec_suspend (basic-s3-devices) [359.899821] Starting subtest: basic-S3-devices [359.902064] Starting dynamic subtest: smem [371.262779] Dynamic subtest smem: SUCCESS (11.362s) [371.265715] Subtest basic-S3-devices: SUCCESS (11.365s) [371.453293] [109/131] (653s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area) [371.571902] Starting subtest: psr2-primary-plane-update-sf-dmg-area [371.574137] Starting dynamic subtest: pipe-A-eDP-1 [377.445134] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.876s) [377.456280] Starting dynamic subtest: pipe-B-eDP-1 [384.112859] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.665s) [384.115079] Subtest psr2-primary-plane-update-sf-dmg-area: SUCCESS (12.544s) [384.992547] [110/131] (640s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-wc) [385.093250] Starting subtest: psr-rgb565-draw-mmap-wc [391.834371] Subtest psr-rgb565-draw-mmap-wc: SUCCESS (6.744s) [391.938080] [111/131] (633s left) kms_big_fb (x-tiled-32bpp-rotate-270) [392.051678] Starting subtest: x-tiled-32bpp-rotate-270 [392.071091] Subtest x-tiled-32bpp-rotate-270: SKIP (0.019s) [392.188784] [112/131] (633s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-downscaling) [392.278327] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-downscaling [392.280639] Starting dynamic subtest: pipe-A-default-mode [393.473450] Dynamic subtest pipe-A-default-mode: SKIP (1.193s) [393.477893] Subtest flip-64bpp-4tile-to-16bpp-4tile-downscaling: SKIP (1.195s) [393.613768] [113/131] (631s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-cpu) [393.714609] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-cpu [397.333616] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (3.623s) [398.539868] [114/131] (627s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-wc) [398.638617] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-wc [398.642758] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [398.733836] [115/131] (626s left) perf_pmu (pmu-read) [398.770376] Starting subtest: pmu-read [398.772541] Subtest pmu-read: SUCCESS (0.003s) [398.884926] [116/131] (626s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-msflip-blt) [398.979200] Starting subtest: fbc-1p-primscrn-indfb-msflip-blt [403.395979] Subtest fbc-1p-primscrn-indfb-msflip-blt: SUCCESS (4.420s) [404.547470] [117/131] (621s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-msflip-blt) [404.644298] Starting subtest: fbcpsr-2p-primscrn-shrfb-msflip-blt [404.648395] Subtest fbcpsr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s) [404.745727] [118/131] (621s left) kms_rotation_crc (sprite-rotation-180) [404.840567] Starting subtest: sprite-rotation-180 [411.639960] Subtest sprite-rotation-180: SUCCESS (6.802s) [412.800906] [119/131] (613s left) fbdev (write) [412.850509] Starting subtest: write [413.208378] Subtest write: SUCCESS (0.356s) [413.279175] [120/131] (612s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu) [413.378963] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu [413.383209] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [413.484670] [121/131] (612s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-blt) [413.600074] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-blt [420.317035] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-blt: SUCCESS (6.721s) [420.454095] [122/131] (605s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs) [420.510857] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs [420.515513] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SKIP (0.000s) [420.709764] [123/131] (605s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-render) [420.810631] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-render [425.228316] Subtest fbc-1p-primscrn-pri-indfb-draw-render: SUCCESS (4.422s) [426.443612] [124/131] (599s left) i915_suspend (fence-restore-tiled2untiled) [426.503497] Starting subtest: fence-restore-tiled2untiled [426.507800] Subtest fence-restore-tiled2untiled: SKIP (0.000s) [426.599572] [125/131] (599s left) kms_properties (colorop-properties-legacy) [426.704102] Starting subtest: colorop-properties-legacy [426.706400] Starting dynamic subtest: pipe-A-eDP-1 [427.060168] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.357s) [427.074605] Starting dynamic subtest: pipe-B-eDP-1 [428.182071] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.118s) [428.192936] Starting dynamic subtest: pipe-C-eDP-1 [429.215539] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.034s) [429.233064] Starting dynamic subtest: pipe-D-eDP-1 [430.242968] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.025s) [430.245319] Subtest colorop-properties-legacy: SUCCESS (3.541s) [431.044091] [126/131] (595s left) gem_pxp (create-regular-context-2) [431.160770] Starting subtest: create-regular-context-2 [431.163152] Subtest create-regular-context-2: SUCCESS (0.002s) [431.287222] [127/131] (594s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs) [431.396433] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs [431.398829] Starting dynamic subtest: pipe-A-eDP-1 [431.419562] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.002s) [431.430957] Starting dynamic subtest: pipe-B-eDP-1 [431.451688] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.002s) [431.461569] Starting dynamic subtest: pipe-C-eDP-1 [431.481622] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.003s) [431.491436] Starting dynamic subtest: pipe-D-eDP-1 [431.511049] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.002s) [431.512934] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs: SUCCESS (0.023s) [433.707446] [128/131] (592s left) syncobj_wait (multi-wait-all-submitted-signaled) [433.764173] Starting subtest: multi-wait-all-submitted-signaled [433.865446] Subtest multi-wait-all-submitted-signaled: SUCCESS (0.101s) [433.944360] [129/131] (592s left) intel_hwmon (hwmon-read) [433.998864] Subtest hwmon-read: SKIP (0.000s) [434.061410] [130/131] (592s left) sw_sync (sync_merge) [434.101886] Starting subtest: sync_merge [434.104222] Subtest sync_merge: SUCCESS (0.000s) [434.172408] [131/131] (592s left) kms_async_flips (test-time-stamp) [434.268821] Starting subtest: test-time-stamp [434.642636] Starting dynamic subtest: pipe-A-eDP-1 [435.405250] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.760s) [435.786592] Starting dynamic subtest: pipe-B-eDP-1 [436.537864] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.760s) [436.902926] Starting dynamic subtest: pipe-C-eDP-1 [437.671686] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.776s) [438.040974] Starting dynamic subtest: pipe-D-eDP-1 [438.803209] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.768s) [438.805511] Subtest test-time-stamp: SUCCESS (4.535s) [439.955481] Closing watchdogs results: parsing output: 0/ for test: kms_tiled_display results: parsing output: 1/ for test: gem_ctx_isolation results: parsing output: 2/ for test: syncobj_timeline results: parsing output: 3/ for test: kms_frontbuffer_tracking results: parsing output: 4/ for test: sysfs_heartbeat_interval results: parsing output: 5/ for test: gem_exec_reloc results: parsing output: 6/ for test: gem_userptr_blits results: parsing output: 7/ for test: kms_frontbuffer_tracking results: parsing output: 8/ for test: i915_pm_rps results: parsing output: 9/ for test: vgem_basic results: parsing output: 10/ for test: kms_psr results: parsing output: 11/ for test: kms_cursor_edge_walk results: parsing output: 12/ for test: syncobj_timeline results: parsing output: 13/ for test: kms_flip_scaled_crc results: parsing output: 14/ for test: gem_gpgpu_fill results: parsing output: 15/ for test: kms_flip results: parsing output: 16/ for test: kms_frontbuffer_tracking results: parsing output: 17/ for test: gem_exec_capture results: parsing output: 18/ for test: gen7_exec_parse results: parsing output: 19/ for test: gem_exec_schedule results: parsing output: 20/ for test: kms_big_fb results: parsing output: 21/ for test: api_intel_bb results: parsing output: 22/ for test: kms_lease results: parsing output: 23/ for test: gem_mmap_wc results: parsing output: 24/ for test: gem_render_copy results: parsing output: 25/ for test: kms_psr2_sf results: parsing output: 26/ for test: kms_frontbuffer_tracking results: parsing output: 27/ for test: kms_frontbuffer_tracking results: parsing output: 28/ for test: kms_frontbuffer_tracking results: parsing output: 29/ for test: gem_exec_whisper results: parsing output: 30/ for test: kms_frontbuffer_tracking results: parsing output: 31/ for test: vgem_basic results: parsing output: 32/ for test: kms_big_fb results: parsing output: 33/ for test: kms_ccs results: parsing output: 34/ for test: kms_busy results: parsing output: 35/ for test: kms_setmode results: parsing output: 36/ for test: kms_frontbuffer_tracking results: parsing output: 37/ for test: gem_exec_fence results: parsing output: 38/ for test: kms_plane results: parsing output: 39/ for test: kms_plane_scaling results: parsing output: 40/ for test: drm_read results: parsing output: 41/ for test: kms_draw_crc results: parsing output: 42/ for test: kms_cursor_crc results: parsing output: 43/ for test: gem_exec_balancer results: parsing output: 44/ for test: gem_mmap_gtt results: parsing output: 45/ for test: gen9_exec_parse results: parsing output: 46/ for test: syncobj_timeline results: parsing output: 47/ for test: kms_plane results: parsing output: 48/ for test: kms_vblank results: parsing output: 49/ for test: kms_chamelium_frames results: parsing output: 50/ for test: syncobj_wait results: parsing output: 51/ for test: kms_psr results: parsing output: 52/ for test: vgem_basic results: parsing output: 53/ for test: kms_content_protection results: parsing output: 54/ for test: kms_hdr results: parsing output: 55/ for test: kms_joiner results: parsing output: 56/ for test: gem_exec_reloc results: parsing output: 57/ for test: gem_partial_pwrite_pread results: parsing output: 58/ for test: gem_close_race results: parsing output: 59/ for test: kms_frontbuffer_tracking results: parsing output: 60/ for test: prime_self_import results: parsing output: 61/ for test: gem_spin_batch results: parsing output: 62/ for test: gem_exec_schedule results: parsing output: 63/ for test: kms_ccs results: parsing output: 64/ for test: gem_ctx_engines results: parsing output: 65/ for test: i915_hangman results: parsing output: 66/ for test: kms_big_fb results: parsing output: 67/ for test: gem_lmem_swapping results: parsing output: 68/ for test: kms_debugfs results: parsing output: 69/ for test: kms_psr results: parsing output: 70/ for test: kms_frontbuffer_tracking results: parsing output: 71/ for test: kms_big_fb results: parsing output: 72/ for test: kms_chamelium_hpd results: parsing output: 73/ for test: gem_ctx_param results: parsing output: 74/ for test: kms_cursor_crc results: parsing output: 75/ for test: kms_flip results: parsing output: 76/ for test: sriov_basic results: parsing output: 77/ for test: kms_pm_rpm results: parsing output: 78/ for test: template results: parsing output: 79/ for test: syncobj_timeline results: parsing output: 80/ for test: gem_exec_params results: parsing output: 81/ for test: kms_frontbuffer_tracking results: parsing output: 82/ for test: gem_exec_fence results: parsing output: 83/ for test: kms_rotation_crc results: parsing output: 84/ for test: kms_ccs results: parsing output: 85/ for test: syncobj_wait results: parsing output: 86/ for test: gem_pread results: parsing output: 87/ for test: syncobj_timeline results: parsing output: 88/ for test: gem_ctx_persistence results: parsing output: 89/ for test: kms_plane results: parsing output: 90/ for test: kms_plane_alpha_blend results: parsing output: 91/ for test: perf results: parsing output: 92/ for test: kms_color results: parsing output: 93/ for test: gem_vm_create results: parsing output: 94/ for test: gem_ctx_param results: parsing output: 95/ for test: gem_mmap_gtt results: parsing output: 96/ for test: kms_big_fb results: parsing output: 97/ for test: core_setmaster results: parsing output: 98/ for test: gem_exec_reloc results: parsing output: 99/ for test: kms_psr results: parsing output: 100/ for test: kms_psr results: parsing output: 101/ for test: gem_workarounds results: parsing output: 102/ for test: gem_sync results: parsing output: 103/ for test: api_intel_allocator results: parsing output: 104/ for test: kms_flip_tiling results: parsing output: 105/ for test: kms_pm_dc results: parsing output: 106/ for test: kms_ccs results: parsing output: 107/ for test: gem_exec_suspend results: parsing output: 108/ for test: kms_psr2_sf results: parsing output: 109/ for test: kms_frontbuffer_tracking results: parsing output: 110/ for test: kms_big_fb results: parsing output: 111/ for test: kms_flip_scaled_crc results: parsing output: 112/ for test: kms_frontbuffer_tracking results: parsing output: 113/ for test: kms_frontbuffer_tracking results: parsing output: 114/ for test: perf_pmu results: parsing output: 115/ for test: kms_frontbuffer_tracking results: parsing output: 116/ for test: kms_frontbuffer_tracking results: parsing output: 117/ for test: kms_rotation_crc results: parsing output: 118/ for test: fbdev results: parsing output: 119/ for test: kms_frontbuffer_tracking results: parsing output: 120/ for test: kms_frontbuffer_tracking results: parsing output: 121/ for test: gem_render_copy results: parsing output: 122/ for test: kms_frontbuffer_tracking results: parsing output: 123/ for test: i915_suspend results: parsing output: 124/ for test: kms_properties results: parsing output: 125/ for test: gem_pxp results: parsing output: 126/ for test: kms_ccs results: parsing output: 127/ for test: syncobj_wait results: parsing output: 128/ for test: intel_hwmon results: parsing output: 129/ for test: sw_sync results: parsing output: 130/ for test: kms_async_flips Done.