[59.274107] Initializing watchdogs [59.274156] /dev/watchdog0 [59.289978] [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] [59.294540] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [59.296828] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [59.300121] [001/155] (960s left) kms_rotation_crc (primary-x-tiled-reflect-x-0) [59.426765] Starting subtest: primary-x-tiled-reflect-x-0 [66.360472] Subtest primary-x-tiled-reflect-x-0: SUCCESS (6.936s) [67.779912] [002/155] (952s left) sysfs_heartbeat_interval (precise) [67.835341] Starting subtest: precise [67.837807] Starting dynamic subtest: vecs0 [74.295576] Dynamic subtest vecs0: SUCCESS (6.459s) [74.306747] Starting dynamic subtest: ccs0 [75.465787] Dynamic subtest ccs0: SUCCESS (1.167s) [75.474294] Starting dynamic subtest: vcs0 [83.325232] Dynamic subtest vcs0: SUCCESS (7.857s) [83.335527] Starting dynamic subtest: bcs0 [84.415485] Dynamic subtest bcs0: SUCCESS (1.089s) [84.424791] Starting dynamic subtest: rcs0 [85.525430] Dynamic subtest rcs0: SUCCESS (1.109s) [85.534157] Starting dynamic subtest: vcs1 [93.308280] Dynamic subtest vcs1: SUCCESS (7.780s) [93.310784] Subtest precise: SUCCESS (25.470s) [93.387668] [003/155] (926s left) gem_exec_params (invalid-bsd2-flag-on-render) [93.445168] Starting subtest: invalid-bsd2-flag-on-render [93.447545] Subtest invalid-bsd2-flag-on-render: SUCCESS (0.000s) [93.543111] [004/155] (926s left) kms_draw_crc (draw-method-mmap-cpu) [93.643883] Starting subtest: draw-method-mmap-cpu [93.646141] Starting dynamic subtest: xrgb8888-untiled [93.909302] Dynamic subtest xrgb8888-untiled: SUCCESS (0.267s) [93.918655] Starting dynamic subtest: rgb565-untiled [94.131740] Dynamic subtest rgb565-untiled: SUCCESS (0.222s) [94.140918] Starting dynamic subtest: xrgb2101010-untiled [94.355197] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.222s) [94.363938] Starting dynamic subtest: xbgr16161616f-untiled [94.586656] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.233s) [94.595848] Starting dynamic subtest: xrgb8888-xtiled [94.719772] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.133s) [94.730506] Starting dynamic subtest: rgb565-xtiled [94.853527] Dynamic subtest rgb565-xtiled: SUCCESS (0.133s) [94.862837] Starting dynamic subtest: xrgb2101010-xtiled [94.975472] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.122s) [94.984066] Starting dynamic subtest: xbgr16161616f-xtiled [95.108719] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.133s) [95.116735] Starting dynamic subtest: xrgb8888-4tiled [95.253133] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.144s) [95.260785] Starting dynamic subtest: rgb565-4tiled [95.397638] Dynamic subtest rgb565-4tiled: SUCCESS (0.144s) [95.405580] Starting dynamic subtest: xrgb2101010-4tiled [95.520521] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.122s) [95.530476] Starting dynamic subtest: xbgr16161616f-4tiled [95.664444] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.144s) [95.666475] Subtest draw-method-mmap-cpu: SUCCESS (2.023s) [95.771308] [005/155] (924s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-async-flip) [95.889757] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-async-flip [96.703618] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (0.815s) [96.884914] [006/155] (923s left) gem_exec_params (rel-constants-invalid-ring) [96.951633] Starting subtest: rel-constants-invalid-ring [96.954081] Subtest rel-constants-invalid-ring: SUCCESS (0.000s) [97.044512] [007/155] (922s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-pri-shrfb-draw-pwrite) [97.138253] Starting subtest: psrhdr-1p-primscrn-pri-shrfb-draw-pwrite [97.142264] Subtest psrhdr-1p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [97.235953] [008/155] (922s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-cur-indfb-draw-mmap-gtt) [97.340677] Starting subtest: hdr-2p-scndscrn-cur-indfb-draw-mmap-gtt [97.345026] Subtest hdr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [97.437320] [009/155] (922s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-move) [97.532188] Starting subtest: psr-2p-primscrn-spr-indfb-move [97.536193] Subtest psr-2p-primscrn-spr-indfb-move: SKIP (0.000s) [97.630945] [010/155] (922s left) gem_exec_whisper (basic-forked-all) [97.683162] Starting subtest: basic-forked-all [110.218288] Subtest basic-forked-all: SUCCESS (12.533s) [110.406220] [011/155] (909s left) gem_mmap (bad-size) [110.461547] Subtest bad-size: SKIP (0.000s) [110.517056] [012/155] (909s left) gen7_exec_parse (cmd-crossing-page) [110.576896] Subtest cmd-crossing-page: SKIP (0.000s) [110.659467] [013/155] (909s left) kms_cursor_legacy (2x-cursor-vs-flip-legacy) [110.800363] Starting subtest: 2x-cursor-vs-flip-legacy [110.805062] Subtest 2x-cursor-vs-flip-legacy: SKIP (0.001s) [110.941751] [014/155] (909s left) gem_softpin (overlap) [110.993338] Starting subtest: overlap [111.902487] Subtest overlap: SUCCESS (0.909s) [112.021919] [015/155] (908s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-upscaling) [112.110388] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-upscaling [112.114700] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-upscaling: SKIP (0.000s) [112.209590] [016/155] (908s left) kms_frontbuffer_tracking (psrhdr-1p-offscreen-pri-shrfb-draw-render) [112.319856] Starting subtest: psrhdr-1p-offscreen-pri-shrfb-draw-render [112.324056] Subtest psrhdr-1p-offscreen-pri-shrfb-draw-render: SKIP (0.000s) [112.412569] [017/155] (908s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-pri-indfb-draw-render) [112.510777] Starting subtest: fbcpsrhdr-2p-scndscrn-pri-indfb-draw-render [112.515178] Subtest fbcpsrhdr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s) [112.610311] [018/155] (907s left) kms_plane_cursor (primary) [112.708835] Starting subtest: primary [112.713164] Starting dynamic subtest: pipe-A-eDP-1-size-64 [115.271683] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.565s) [115.297372] Starting dynamic subtest: pipe-A-eDP-1-size-128 [117.872564] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.583s) [117.898599] Starting dynamic subtest: pipe-A-eDP-1-size-256 [120.440338] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.550s) [120.765055] Starting dynamic subtest: pipe-B-eDP-1-size-64 [124.094468] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.341s) [124.121390] Starting dynamic subtest: pipe-B-eDP-1-size-128 [126.696232] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.583s) [126.720799] Starting dynamic subtest: pipe-B-eDP-1-size-256 [129.308058] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.594s) [129.625112] Starting dynamic subtest: pipe-C-eDP-1-size-64 [132.534283] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.921s) [132.561592] Starting dynamic subtest: pipe-C-eDP-1-size-128 [134.757081] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.203s) [134.782700] Starting dynamic subtest: pipe-C-eDP-1-size-256 [136.967623] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.192s) [137.300399] Starting dynamic subtest: pipe-D-eDP-1-size-64 [140.314402] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (3.026s) [140.343956] Starting dynamic subtest: pipe-D-eDP-1-size-128 [142.536260] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.202s) [142.562851] Starting dynamic subtest: pipe-D-eDP-1-size-256 [144.804219] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.247s) [145.121158] Subtest primary: SUCCESS (32.412s) [145.926325] [019/155] (874s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary) [146.030957] Starting subtest: fbcpsr-indfb-scaledprimary [151.802513] Subtest fbcpsr-indfb-scaledprimary: SUCCESS (5.775s) [151.939283] [020/155] (868s left) gem_ctx_persistence (legacy-engines-mixed) [152.003432] Starting subtest: legacy-engines-mixed [152.005721] Starting dynamic subtest: render [152.101674] Dynamic subtest render: SUCCESS (0.097s) [152.115322] Starting dynamic subtest: bsd1 [152.170955] Dynamic subtest bsd1: SUCCESS (0.066s) [152.182101] Starting dynamic subtest: bsd2 [152.213544] Dynamic subtest bsd2: SUCCESS (0.040s) [152.223040] Starting dynamic subtest: blt [152.280955] Dynamic subtest blt: SUCCESS (0.065s) [152.292753] Starting dynamic subtest: vebox [152.339843] Dynamic subtest vebox: SUCCESS (0.056s) [152.342590] Subtest legacy-engines-mixed: SUCCESS (0.337s) [152.430745] [021/155] (868s left) kms_big_fb (x-tiled-32bpp-rotate-270) [152.536443] Starting subtest: x-tiled-32bpp-rotate-270 [152.559837] Subtest x-tiled-32bpp-rotate-270: SKIP (0.023s) [152.683916] [022/155] (867s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted-submitted) [152.745960] Starting subtest: etime-multi-wait-for-submit-unsubmitted-submitted [152.847902] Subtest etime-multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.102s) [152.940007] [023/155] (867s left) kms_color (ctm-green-to-red) [153.037481] Starting subtest: ctm-green-to-red [153.039257] Starting dynamic subtest: pipe-A-eDP-1 [153.739667] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.703s) [153.749232] Starting dynamic subtest: pipe-B-eDP-1 [155.204082] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.462s) [155.213339] Starting dynamic subtest: pipe-C-eDP-1 [156.537779] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.333s) [156.547710] Starting dynamic subtest: pipe-D-eDP-1 [157.886954] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.349s) [157.889483] Subtest ctm-green-to-red: SUCCESS (4.850s) [158.695985] [024/155] (862s left) kms_flip (2x-flip-vs-modeset) [158.797259] Starting subtest: 2x-flip-vs-modeset [158.808260] Subtest 2x-flip-vs-modeset: SKIP (0.012s) [158.895274] [025/155] (861s left) kms_frontbuffer_tracking (hdr-1p-primscrn-spr-indfb-draw-mmap-cpu) [159.000618] Starting subtest: hdr-1p-primscrn-spr-indfb-draw-mmap-cpu [159.005062] Subtest hdr-1p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [159.124112] [026/155] (861s left) perf_pmu (gt-awake) [159.163494] Starting subtest: gt-awake [168.318601] Subtest gt-awake: SUCCESS (9.155s) [168.409574] [027/155] (852s left) kms_getfb (getfb-handle-valid) [168.506272] Starting subtest: getfb-handle-valid [168.508550] Subtest getfb-handle-valid: SUCCESS (0.000s) [168.598039] [028/155] (852s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-plflip-blt) [168.700620] Starting subtest: fbc-2p-primscrn-indfb-plflip-blt [168.704656] Subtest fbc-2p-primscrn-indfb-plflip-blt: SKIP (0.000s) [168.791762] [029/155] (852s left) kms_pm_dc (dc5-retention-flops) [169.888133] Starting subtest: dc5-retention-flops [169.892197] Subtest dc5-retention-flops: SKIP (0.000s) [169.957232] [030/155] (851s left) gem_exec_reloc (basic-gtt) [170.019662] Subtest basic-gtt: SKIP (0.000s) [170.082086] [031/155] (850s left) kms_flip (2x-flip-vs-absolute-wf_vblank) [170.179679] Starting subtest: 2x-flip-vs-absolute-wf_vblank [170.188462] Subtest 2x-flip-vs-absolute-wf_vblank: SKIP (0.011s) [170.263109] [032/155] (850s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-gtt) [170.369899] Starting subtest: fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-gtt [170.374167] Subtest fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [170.466995] [033/155] (850s left) kms_properties (plane-properties-atomic) [170.561186] Starting subtest: plane-properties-atomic [170.563560] Starting dynamic subtest: pipe-A-eDP-1 [171.098229] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.535s) [171.108581] Starting dynamic subtest: pipe-B-eDP-1 [172.357162] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.260s) [172.366806] Starting dynamic subtest: pipe-C-eDP-1 [173.580326] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.221s) [173.590675] Starting dynamic subtest: pipe-D-eDP-1 [174.807824] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.226s) [174.810341] Subtest plane-properties-atomic: SUCCESS (4.248s) [175.626374] [034/155] (845s left) kms_big_fb (4-tiled-16bpp-rotate-0) [175.731515] Starting subtest: 4-tiled-16bpp-rotate-0 [176.999707] Subtest 4-tiled-16bpp-rotate-0: SUCCESS (1.268s) [177.132222] [035/155] (844s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-gtt) [177.239864] Starting subtest: fbc-rgb101010-draw-mmap-gtt [177.243210] Subtest fbc-rgb101010-draw-mmap-gtt: SKIP (0.000s) [177.340860] [036/155] (843s left) kms_chamelium_hpd (hdmi-hpd-for-each-pipe) [177.729200] Subtest hdmi-hpd-for-each-pipe: SKIP (0.000s) [178.533695] [037/155] (842s left) i915_drm_fdinfo (basics) [178.579165] Starting subtest: basics [178.581537] Subtest basics: SUCCESS (0.000s) [178.656832] [038/155] (842s left) gem_exec_params (readonly) [178.702741] Starting subtest: readonly [178.705045] Subtest readonly: SUCCESS (0.002s) [178.813093] [039/155] (842s left) gem_spin_batch (legacy-resubmit-new) [178.866052] Starting subtest: legacy-resubmit-new [178.868483] Starting dynamic subtest: default [178.876974] Dynamic subtest default: SUCCESS (0.011s) [178.889080] Starting dynamic subtest: render [178.891287] Dynamic subtest render: SUCCESS (0.003s) [178.901230] Starting dynamic subtest: bsd [178.903398] Dynamic subtest bsd: SUCCESS (0.004s) [178.912403] Starting dynamic subtest: bsd1 [178.914528] Dynamic subtest bsd1: SUCCESS (0.004s) [178.923112] Starting dynamic subtest: bsd2 [178.925278] Dynamic subtest bsd2: SUCCESS (0.004s) [178.934920] Starting dynamic subtest: blt [178.937099] Dynamic subtest blt: SUCCESS (0.004s) [178.945712] Starting dynamic subtest: vebox [178.947816] Dynamic subtest vebox: SUCCESS (0.005s) [178.950036] Subtest legacy-resubmit-new: SUCCESS (0.040s) [180.337254] [040/155] (841s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip) [180.437699] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip [181.050962] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.614s) [181.213147] [041/155] (840s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180) [181.310163] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180 [181.314664] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s) [181.396224] [042/155] (840s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-rc-ccs) [181.490132] Starting subtest: ccs-on-another-bo-y-tiled-gen12-rc-ccs [181.492272] Starting dynamic subtest: pipe-A-eDP-1 [181.516097] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [181.527884] Starting dynamic subtest: pipe-B-eDP-1 [181.549532] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [181.559056] Starting dynamic subtest: pipe-C-eDP-1 [181.581462] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [181.591767] Starting dynamic subtest: pipe-D-eDP-1 [181.615539] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [181.619836] Subtest ccs-on-another-bo-y-tiled-gen12-rc-ccs: SKIP (0.004s) [183.819316] [043/155] (837s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-pri-indfb-draw-mmap-cpu) [183.923982] Starting subtest: fbcpsrhdr-1p-primscrn-pri-indfb-draw-mmap-cpu [183.928213] Subtest fbcpsrhdr-1p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s) [184.003524] [044/155] (837s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling) [184.094900] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling [184.099159] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.000s) [184.168197] [045/155] (837s left) gem_exec_fence (syncobj-signal) [184.640935] Starting subtest: syncobj-signal [184.646691] Subtest syncobj-signal: SUCCESS (0.005s) [186.382812] [FACT gem_exec_fence (syncobj-signal)] new: kernel.kmod_is_loaded.vgem: true [186.386787] [046/155] (835s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-render) [186.490949] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-render [186.495283] Subtest psr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s) [186.600580] [047/155] (835s left) kms_cursor_crc (cursor-tearing-position-change) [186.708290] Starting subtest: cursor-tearing-position-change [186.710863] Starting dynamic subtest: pipe-A-eDP-1 [187.272080] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.563s) [187.285094] Starting dynamic subtest: pipe-D-eDP-1 [188.535424] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.257s) [188.537386] Subtest cursor-tearing-position-change: SUCCESS (1.825s) [189.365788] [048/155] (832s left) prime_mmap_coherency (write) [189.433743] Starting subtest: write [194.810689] Subtest write: SUCCESS (5.376s) [194.969505] [049/155] (826s left) sw_sync (sync_busy_fork_unixsocket) [195.003248] Starting subtest: sync_busy_fork_unixsocket [195.011485] Subtest sync_busy_fork_unixsocket: SUCCESS (0.010s) [195.074019] [050/155] (826s left) gem_userptr_blits (usage-restrictions) [195.131736] Starting subtest: usage-restrictions [195.133842] Subtest usage-restrictions: SUCCESS (0.000s) [195.247917] [051/155] (826s left) gem_ctx_param (set-priority-not-supported) [195.305872] Starting subtest: set-priority-not-supported [195.311135] Subtest set-priority-not-supported: SKIP (0.000s) [195.404426] [052/155] (826s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-shrfb-pgflip-blt) [195.507205] Starting subtest: psrhdr-2p-primscrn-shrfb-pgflip-blt [195.511653] Subtest psrhdr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s) [195.603575] [053/155] (826s left) gem_mmap_gtt (hang) [195.660048] Subtest hang: SKIP (0.000s) [195.718769] [054/155] (826s left) kms_cdclk (plane-scaling) [195.802048] Starting subtest: plane-scaling [195.804395] Starting dynamic subtest: pipe-A-eDP-1 [196.100134] Dynamic subtest pipe-A-eDP-1: SKIP (0.295s) [196.110399] Starting dynamic subtest: pipe-B-eDP-1 [196.115128] Dynamic subtest pipe-B-eDP-1: SKIP (0.002s) [196.124736] Starting dynamic subtest: pipe-C-eDP-1 [196.129453] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [196.138554] Starting dynamic subtest: pipe-D-eDP-1 [196.143094] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [196.147568] Subtest plane-scaling: SKIP (0.303s) [196.896021] [055/155] (825s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-pri-indfb-draw-blt) [196.997121] Starting subtest: fbchdr-1p-primscrn-pri-indfb-draw-blt [197.001215] Subtest fbchdr-1p-primscrn-pri-indfb-draw-blt: SKIP (0.000s) [197.095588] [056/155] (824s left) gem_gpgpu_fill (offset-16x16) [197.158305] Starting subtest: offset-16x16 [197.163162] Subtest offset-16x16: SUCCESS (0.006s) [197.319766] [057/155] (824s left) gem_render_copy (y-tiled-ccs-to-y-tiled) [197.385897] Starting subtest: y-tiled-ccs-to-y-tiled [197.390362] Subtest y-tiled-ccs-to-y-tiled: SKIP (0.000s) [197.574181] [058/155] (824s left) gem_exec_schedule (preempt-queue) [197.651863] Subtest preempt-queue: SKIP (0.000s) [197.946907] [059/155] (824s left) gem_mmap_gtt (isolation) [197.996175] Subtest isolation: SKIP (0.000s) [198.062642] [060/155] (824s left) i915_pm_rpm (sysfs-read) [199.606091] Starting subtest: sysfs-read [200.777133] Subtest sysfs-read: SUCCESS (1.169s) [201.152499] [061/155] (821s left) kms_lease (cursor-implicit-plane) [201.254147] Starting subtest: cursor-implicit-plane [201.256410] Starting dynamic subtest: pipe-A-eDP-1 [201.727964] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.474s) [201.738779] Starting dynamic subtest: pipe-B-eDP-1 [202.870134] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.141s) [202.880056] Starting dynamic subtest: pipe-C-eDP-1 [203.971750] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.098s) [203.981240] Starting dynamic subtest: pipe-D-eDP-1 [205.099718] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.127s) [205.102044] Subtest cursor-implicit-plane: SUCCESS (3.846s) [205.959303] [062/155] (816s left) kms_psr2_sf (psr2-plane-move-sf-dmg-area) [206.058075] Starting subtest: psr2-plane-move-sf-dmg-area [206.060375] Starting dynamic subtest: pipe-A-eDP-1 [210.600912] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.548s) [210.611407] Starting dynamic subtest: pipe-B-eDP-1 [215.931072] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.326s) [215.933403] Subtest psr2-plane-move-sf-dmg-area: SUCCESS (9.877s) [216.811437] [063/155] (805s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-pri-indfb-draw-mmap-wc) [216.914910] Starting subtest: fbchdr-2p-scndscrn-pri-indfb-draw-mmap-wc [216.919110] Subtest fbchdr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [217.009960] [064/155] (805s left) kms_frontbuffer_tracking (hdr-farfromfence-mmap-gtt) [217.112022] Starting subtest: hdr-farfromfence-mmap-gtt [217.116330] Subtest hdr-farfromfence-mmap-gtt: SKIP (0.000s) [217.202216] [065/155] (805s left) kms_vrr (flipline) [217.312351] Starting subtest: flipline [217.318689] Subtest flipline: SKIP (0.000s) [217.397532] [066/155] (805s left) i915_suspend (debugfs-reader) [217.455071] Starting subtest: debugfs-reader [235.552535] Subtest debugfs-reader: SUCCESS (3.254s) [235.705021] [067/155] (786s left) kms_frontbuffer_tracking (psrhdr-1p-offscreen-pri-indfb-draw-pwrite) [235.809903] Starting subtest: psrhdr-1p-offscreen-pri-indfb-draw-pwrite [235.814040] Subtest psrhdr-1p-offscreen-pri-indfb-draw-pwrite: SKIP (0.000s) [235.905913] [068/155] (786s left) kms_cursor_crc (cursor-dpms) [236.029693] Starting subtest: cursor-dpms [236.032022] Starting dynamic subtest: pipe-A-eDP-1 [239.115354] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.080s) [239.125868] Starting dynamic subtest: pipe-D-eDP-1 [242.786047] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.665s) [242.788452] Subtest cursor-dpms: SUCCESS (6.750s) [243.636045] [069/155] (779s left) kms_vblank (query-forked-hang) [243.724752] Starting subtest: query-forked-hang [243.727047] Starting dynamic subtest: pipe-A-eDP-1 [270.909307] Dynamic subtest pipe-A-eDP-1: SUCCESS (27.178s) [270.924909] Starting dynamic subtest: pipe-D-eDP-1 [295.867577] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.950s) [295.869403] Subtest query-forked-hang: SUCCESS (52.133s) [296.705572] [070/155] (726s left) kms_cursor_crc (cursor-rapid-movement-512x170) [296.992922] Starting subtest: cursor-rapid-movement-512x170 [296.997303] Subtest cursor-rapid-movement-512x170: SKIP (0.001s) [297.143734] [071/155] (725s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu) [297.248522] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu [297.252799] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s) [297.364833] [072/155] (725s left) kms_busy (extended-pageflip-modeset-hang-oldfb) [297.462886] Starting subtest: extended-pageflip-modeset-hang-oldfb [297.465157] Starting dynamic subtest: pipe-A [305.365254] Dynamic subtest pipe-A: SUCCESS (7.900s) [305.378066] Starting dynamic subtest: pipe-D [314.034239] Dynamic subtest pipe-D: SUCCESS (8.664s) [314.036498] Subtest extended-pageflip-modeset-hang-oldfb: SUCCESS (16.569s) [314.866890] [073/155] (708s left) gem_exec_reloc (basic-wc-gtt-active) [314.930525] Subtest basic-wc-gtt-active: SKIP (0.000s) [315.008801] [074/155] (707s left) fbdev (nullptr) [315.051798] Starting subtest: nullptr [315.054128] Subtest nullptr: SUCCESS (0.000s) [315.107808] [075/155] (707s left) kms_chamelium_frames (hdmi-cmp-planar-formats) [315.499584] Subtest hdmi-cmp-planar-formats: SKIP (0.000s) [316.290931] [076/155] (706s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu) [316.391399] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu [316.395420] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s) [316.490655] [077/155] (706s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-blt) [316.589904] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-blt [316.594281] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s) [316.680936] [078/155] (706s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset) [316.789290] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset [316.791642] Starting dynamic subtest: A-eDP1 [320.448977] Dynamic subtest A-eDP1: SUCCESS (3.655s) [320.460985] Starting dynamic subtest: B-eDP1 [323.666592] Dynamic subtest B-eDP1: SUCCESS (3.219s) [323.678478] Starting dynamic subtest: C-eDP1 [326.879294] Dynamic subtest C-eDP1: SUCCESS (3.209s) [326.890528] Starting dynamic subtest: D-eDP1 [330.087454] Dynamic subtest D-eDP1: SUCCESS (3.207s) [330.089810] Subtest single-buffer-flip-vs-dpms-off-vs-modeset: SUCCESS (13.297s) [330.909234] [079/155] (692s left) syncobj_timeline (multi-wait-all-available-submitted) [330.965717] Starting subtest: multi-wait-all-available-submitted [330.968038] Subtest multi-wait-all-available-submitted: SUCCESS (0.000s) [331.104610] [080/155] (692s left) perf (gen12-group-exclusive-stream-ctx-handle) [331.231930] Starting subtest: gen12-group-exclusive-stream-ctx-handle [331.258929] Subtest gen12-group-exclusive-stream-ctx-handle: SUCCESS (0.027s) [331.300923] [081/155] (691s left) prime_mmap_kms (buffer-sharing) [333.126266] Starting subtest: buffer-sharing [333.573546] Subtest buffer-sharing: SUCCESS (0.447s) [334.423979] [082/155] (688s left) kms_frontbuffer_tracking (hdr-1p-primscrn-pri-indfb-draw-blt) [334.533377] Starting subtest: hdr-1p-primscrn-pri-indfb-draw-blt [334.537525] Subtest hdr-1p-primscrn-pri-indfb-draw-blt: SKIP (0.000s) [334.634742] [083/155] (688s left) gem_mmap_wc (read) [334.688316] Subtest read: SKIP (0.000s) [334.753519] [084/155] (688s left) gem_ppgtt (blt-vs-render-ctx0) [334.806661] Starting subtest: blt-vs-render-ctx0 [367.801944] Subtest blt-vs-render-ctx0: SUCCESS (32.996s) [367.945262] [085/155] (655s left) kms_rotation_crc (sprite-rotation-90-pos-100-0) [368.080838] Starting subtest: sprite-rotation-90-pos-100-0 [368.086271] Subtest sprite-rotation-90-pos-100-0: SKIP (0.001s) [368.155910] [086/155] (655s left) syncobj_wait (invalid-reset-bad-pad) [368.220856] Starting subtest: invalid-reset-bad-pad [368.223320] Subtest invalid-reset-bad-pad: SUCCESS (0.000s) [368.314717] [087/155] (655s left) gem_userptr_blits (map-fixed-invalidate-overlap-busy) [368.396335] Starting subtest: map-fixed-invalidate-overlap-busy [368.401503] Subtest map-fixed-invalidate-overlap-busy: SKIP (0.000s) [368.518699] [088/155] (655s left) i915_pm_freq_api (freq-basic-api) [368.585137] Starting subtest: freq-basic-api [368.587501] Starting dynamic subtest: gt0 [368.589922] Dynamic subtest gt0: SUCCESS (0.003s) [368.601675] Starting dynamic subtest: gt1 [368.603647] Dynamic subtest gt1: SUCCESS (0.003s) [368.605568] Subtest freq-basic-api: SUCCESS (0.007s) [368.722472] [089/155] (654s left) gem_exec_balancer (hang) [368.997666] Starting subtest: hang [370.725809] Subtest hang: SUCCESS (1.733s) [370.850376] [090/155] (652s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-gtt) [370.961046] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-gtt [370.965350] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [371.046764] [091/155] (652s left) gem_exec_params (invalid-bsd-ring) [371.101460] Starting subtest: invalid-bsd-ring [371.103830] Subtest invalid-bsd-ring: SUCCESS (0.000s) [371.197446] [092/155] (652s left) kms_plane (pixel-format-y-tiled-ccs-modifier) [371.294782] Starting subtest: pixel-format-y-tiled-ccs-modifier [371.298710] Subtest pixel-format-y-tiled-ccs-modifier: SKIP (0.000s) [371.368978] [093/155] (652s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-spr-indfb-draw-pwrite) [371.462966] Starting subtest: fbcpsrhdr-1p-primscrn-spr-indfb-draw-pwrite [371.467545] Subtest fbcpsrhdr-1p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [371.577259] [094/155] (652s left) gem_mmap (bad-object) [371.641995] Subtest bad-object: SKIP (0.000s) [371.728533] [095/155] (652s left) api_intel_bb (object-noreloc-keep-cache-simple) [371.792776] Starting subtest: object-noreloc-keep-cache-simple [371.794970] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.005s) [371.933552] [096/155] (652s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-offscreen-pri-indfb-draw-mmap-gtt) [372.043490] Starting subtest: fbcpsrhdr-1p-offscreen-pri-indfb-draw-mmap-gtt [372.046954] Subtest fbcpsrhdr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [372.136523] [097/155] (651s left) kms_big_fb (y-tiled-64bpp-rotate-180) [372.240520] Starting subtest: y-tiled-64bpp-rotate-180 [372.244256] Subtest y-tiled-64bpp-rotate-180: SKIP (0.000s) [372.349059] [098/155] (651s left) kms_lease (master-vs-lease) [372.448286] Starting subtest: master-vs-lease [372.450256] Subtest master-vs-lease: SUCCESS (0.001s) [372.549935] [099/155] (651s left) device_reset (unbind-reset-rebind) [372.595663] Starting subtest: unbind-reset-rebind [377.663767] Subtest unbind-reset-rebind: SUCCESS (5.061s) [377.705280] [100/155] (646s left) kms_psr (psr-sprite-blt) [377.815098] Starting subtest: psr-sprite-blt [377.817406] Starting dynamic subtest: eDP-1 [379.587226] Dynamic subtest eDP-1: SUCCESS (1.773s) [379.589631] Subtest psr-sprite-blt: SUCCESS (1.774s) [380.448077] [101/155] (643s left) gem_mmap_wc (write-prefaulted) [380.514227] Subtest write-prefaulted: SKIP (0.000s) [380.581686] [102/155] (643s left) gem_render_copy (y-tiled-mc-ccs-to-y-tiled-ccs) [380.640286] Starting subtest: y-tiled-mc-ccs-to-y-tiled-ccs [380.645020] Subtest y-tiled-mc-ccs-to-y-tiled-ccs: SKIP (0.000s) [380.835585] [103/155] (643s left) syncobj_timeline (reset-unsignaled) [380.889512] Starting subtest: reset-unsignaled [380.891474] Subtest reset-unsignaled: SUCCESS (0.000s) [381.005169] [104/155] (643s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt) [381.101976] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt [381.106210] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [381.189187] [105/155] (643s left) kms_psr (fbc-pr-sprite-plane-onoff) [381.281133] Starting subtest: fbc-pr-sprite-plane-onoff [381.285286] Subtest fbc-pr-sprite-plane-onoff: SKIP (0.000s) [381.357472] [106/155] (643s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier) [381.454904] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier [381.459280] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier: SKIP (0.000s) [381.530647] [107/155] (642s left) kms_frontbuffer_tracking (fbcpsrhdr-rgb565-draw-mmap-gtt) [381.633518] Starting subtest: fbcpsrhdr-rgb565-draw-mmap-gtt [381.637527] Subtest fbcpsrhdr-rgb565-draw-mmap-gtt: SKIP (0.000s) [381.736127] [108/155] (642s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-hflip) [381.839684] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-hflip [382.886820] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-hflip: SUCCESS (1.045s) [383.002331] [109/155] (641s left) gem_ctx_engines (independent) [383.061005] Starting subtest: independent [383.063433] Starting dynamic subtest: rcs0 [383.191775] Dynamic subtest rcs0: SUCCESS (0.129s) [383.207030] Starting dynamic subtest: bcs0 [383.299350] Dynamic subtest bcs0: SUCCESS (0.108s) [383.312891] Starting dynamic subtest: vcs0 [383.406498] Dynamic subtest vcs0: SUCCESS (0.106s) [383.417480] Starting dynamic subtest: vcs1 [383.523848] Dynamic subtest vcs1: SUCCESS (0.115s) [383.537626] Starting dynamic subtest: vecs0 [383.643103] Dynamic subtest vecs0: SUCCESS (0.119s) [383.658321] Starting dynamic subtest: ccs0 [383.770979] Dynamic subtest ccs0: SUCCESS (0.127s) [383.785770] Starting dynamic subtest: all-engines [384.283085] Dynamic subtest all-engines: SUCCESS (0.511s) [384.285336] Subtest independent: SUCCESS (1.222s) [385.283243] [110/155] (639s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-onoff) [385.383674] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-onoff [392.483081] Subtest fbcpsr-1p-primscrn-spr-indfb-onoff: SUCCESS (7.105s) [392.641658] [111/155] (631s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-cpu) [392.740640] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-cpu [396.280157] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (3.545s) [397.408955] [112/155] (627s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-pwrite) [397.508211] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-pwrite [404.695793] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (7.192s) [404.849183] [113/155] (619s left) gem_render_copy (yf-tiled) [404.908468] Starting subtest: yf-tiled [404.913433] Subtest yf-tiled: SKIP (0.000s) [405.104825] [114/155] (619s left) kms_frontbuffer_tracking (psrhdr-rgb565-draw-mmap-cpu) [405.195860] Starting subtest: psrhdr-rgb565-draw-mmap-cpu [405.199956] Subtest psrhdr-rgb565-draw-mmap-cpu: SKIP (0.000s) [405.306572] [115/155] (619s left) kms_cursor_legacy (cursora-vs-flipb-legacy) [405.436644] Starting subtest: cursorA-vs-flipB-legacy [405.441352] Subtest cursorA-vs-flipB-legacy: SKIP (0.001s) [405.582733] [116/155] (619s left) gem_exec_fence (basic-busy) [405.759050] Starting subtest: basic-busy [405.761801] Starting dynamic subtest: rcs0 [405.821581] Dynamic subtest rcs0: SUCCESS (0.063s) [405.835336] Starting dynamic subtest: bcs0 [405.889742] Dynamic subtest bcs0: SUCCESS (0.066s) [405.903891] Starting dynamic subtest: vcs0 [405.947361] Dynamic subtest vcs0: SUCCESS (0.055s) [405.960376] Starting dynamic subtest: vcs1 [406.008197] Dynamic subtest vcs1: SUCCESS (0.059s) [406.021054] Starting dynamic subtest: vecs0 [406.064253] Dynamic subtest vecs0: SUCCESS (0.054s) [406.077050] Starting dynamic subtest: ccs0 [406.117233] Dynamic subtest ccs0: SUCCESS (0.051s) [406.119817] Subtest basic-busy: SUCCESS (0.360s) [408.207388] [117/155] (616s left) kms_psr (fbc-psr-primary-mmap-cpu) [408.304460] Starting subtest: fbc-psr-primary-mmap-cpu [408.306763] Starting dynamic subtest: eDP-1 [408.310852] Dynamic subtest eDP-1: SKIP (0.000s) [408.315011] Subtest fbc-psr-primary-mmap-cpu: SKIP (0.001s) [408.379185] [118/155] (616s left) kms_flip (flip-vs-panning) [408.484164] Starting subtest: flip-vs-panning [408.486407] Starting dynamic subtest: A-eDP1 [417.197052] Dynamic subtest A-eDP1: SUCCESS (8.714s) [417.214791] Starting dynamic subtest: B-eDP1 [425.913944] Dynamic subtest B-eDP1: SUCCESS (8.714s) [425.927764] Starting dynamic subtest: C-eDP1 [434.626440] Dynamic subtest C-eDP1: SUCCESS (8.709s) [434.637826] Starting dynamic subtest: D-eDP1 [443.354858] Dynamic subtest D-eDP1: SUCCESS (8.726s) [443.359040] Subtest flip-vs-panning: SUCCESS (34.874s) [444.533173] [119/155] (580s left) kms_atomic_transition (plane-use-after-nonblocking-unbind-fencing) [444.626979] Starting subtest: plane-use-after-nonblocking-unbind-fencing [444.629270] Starting dynamic subtest: pipe-A-eDP-1 [444.688488] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.063s) [445.003137] Starting dynamic subtest: pipe-B-eDP-1 [445.814165] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.824s) [446.114988] Subtest plane-use-after-nonblocking-unbind-fencing: SUCCESS (1.487s) [446.993924] [120/155] (577s left) kms_dp_linktrain_fallback (dp-fallback) [447.091162] Starting subtest: dp-fallback [447.097716] Subtest dp-fallback: SKIP (0.000s) [447.164859] [121/155] (577s left) kms_ccs (crc-primary-suspend-y-tiled-ccs) [447.257903] Starting subtest: crc-primary-suspend-y-tiled-ccs [447.260049] Starting dynamic subtest: pipe-A-eDP-1 [447.268950] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [447.281097] Starting dynamic subtest: pipe-B-eDP-1 [447.290016] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [447.301057] Starting dynamic subtest: pipe-C-eDP-1 [447.309521] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [447.319937] Starting dynamic subtest: pipe-D-eDP-1 [447.328157] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [447.332265] Subtest crc-primary-suspend-y-tiled-ccs: SKIP (0.005s) [449.561005] [122/155] (575s left) gem_exec_flush (basic-uc-prw-default) [449.633525] Starting subtest: basic-uc-prw-default [455.114353] Subtest basic-uc-prw-default: SUCCESS (5.462s) [455.285887] [123/155] (569s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-wc) [455.394647] Starting subtest: psr-rgb101010-draw-mmap-wc [462.653084] Subtest psr-rgb101010-draw-mmap-wc: SUCCESS (7.263s) [462.773269] [124/155] (562s left) api_intel_allocator (fork-simple-once) [462.836297] Starting subtest: fork-simple-once [462.851350] Subtest fork-simple-once: SUCCESS (0.017s) [462.984231] [125/155] (562s left) syncobj_timeline (wait-all-snapshot) [463.033145] Starting subtest: wait-all-snapshot [463.113761] Subtest wait-all-snapshot: SUCCESS (0.081s) [463.194431] [126/155] (562s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-move) [463.292559] Starting subtest: psr-1p-primscrn-spr-indfb-move [470.650017] Subtest psr-1p-primscrn-spr-indfb-move: SUCCESS (7.362s) [470.793652] [127/155] (554s left) kms_psr (psr2-cursor-plane-move) [470.894490] Starting subtest: psr2-cursor-plane-move [470.896861] Starting dynamic subtest: eDP-1 [472.584197] Dynamic subtest eDP-1: SUCCESS (1.690s) [472.586649] Subtest psr2-cursor-plane-move: SUCCESS (1.691s) [473.476633] [128/155] (551s left) gem_vm_create (isolation) [473.538405] Starting subtest: isolation [473.547182] Subtest isolation: SUCCESS (0.009s) [473.685238] [129/155] (551s left) kms_pm_rpm (system-suspend-idle) [475.329665] Starting subtest: system-suspend-idle [494.780406] Subtest system-suspend-idle: SUCCESS (4.317s) [495.180889] [130/155] (530s left) gem_exec_flush (basic-wb-ro-default) [495.245017] Starting subtest: basic-wb-ro-default [500.735407] Subtest basic-wb-ro-default: SUCCESS (5.460s) [500.904053] [131/155] (524s left) kms_prop_blob (invalid-set-prop) [500.960233] Starting subtest: invalid-set-prop [500.962455] Subtest invalid-set-prop: SUCCESS (0.000s) [501.062994] [132/155] (524s left) kms_cursor_legacy (short-flip-before-cursor-toggle) [501.195832] Starting subtest: short-flip-before-cursor-toggle [502.125437] Subtest short-flip-before-cursor-toggle: SUCCESS (0.928s) [503.009065] [133/155] (522s left) kms_plane_scaling (plane-upscale-20x20-with-rotation) [503.103775] Starting subtest: plane-upscale-20x20-with-rotation [503.106051] Starting dynamic subtest: pipe-A [503.328851] Dynamic subtest pipe-A: SUCCESS (0.227s) [503.340799] Starting dynamic subtest: pipe-B [504.605770] Dynamic subtest pipe-B: SUCCESS (1.274s) [504.617377] Starting dynamic subtest: pipe-C [505.938341] Dynamic subtest pipe-C: SUCCESS (1.331s) [505.949670] Starting dynamic subtest: pipe-D [507.272682] Dynamic subtest pipe-D: SUCCESS (1.331s) [507.275230] Subtest plane-upscale-20x20-with-rotation: SUCCESS (4.168s) [508.469665] [134/155] (517s left) gem_exec_schedule (smoketest) [508.657097] Starting subtest: smoketest [508.659206] Starting dynamic subtest: rcs0 [514.260967] Dynamic subtest rcs0: SUCCESS (5.501s) [514.275020] Starting dynamic subtest: bcs0 [519.765156] Dynamic subtest bcs0: SUCCESS (5.498s) [519.779375] Starting dynamic subtest: vcs0 [525.258722] Dynamic subtest vcs0: SUCCESS (5.488s) [525.273991] Starting dynamic subtest: vcs1 [530.762412] Dynamic subtest vcs1: SUCCESS (5.502s) [530.779948] Starting dynamic subtest: vecs0 [536.252979] Dynamic subtest vecs0: SUCCESS (5.491s) [536.268570] Starting dynamic subtest: ccs0 [541.743479] Dynamic subtest ccs0: SUCCESS (5.487s) [541.745611] Subtest smoketest: SUCCESS (32.979s) [541.862522] [135/155] (483s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-fully-sf) [541.974995] Starting subtest: pr-cursor-plane-move-continuous-exceed-fully-sf [541.979214] Subtest pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s) [542.062983] [136/155] (483s left) kms_hdr (bpc-switch) [542.165344] Starting subtest: bpc-switch [542.167626] Starting dynamic subtest: pipe-A-eDP-1-XRGB2101010 [546.740230] Dynamic subtest pipe-A-eDP-1-XRGB2101010: SUCCESS (4.576s) [546.753297] Starting dynamic subtest: pipe-A-eDP-1-XRGB16161616F [551.284225] Dynamic subtest pipe-A-eDP-1-XRGB16161616F: SUCCESS (4.542s) [551.286698] Subtest bpc-switch: SUCCESS (9.121s) [551.400080] [137/155] (474s left) kms_content_protection (atomic-hdcp14) [551.557620] Starting subtest: atomic-hdcp14 [551.563754] Subtest atomic-hdcp14: SKIP (0.000s) [551.690277] [138/155] (474s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs-cc) [551.786704] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs-cc [551.788950] Starting dynamic subtest: pipe-A-eDP-1 [551.812025] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [551.824371] Starting dynamic subtest: pipe-B-eDP-1 [551.847727] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [551.861183] Starting dynamic subtest: pipe-C-eDP-1 [551.883252] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [551.894454] Starting dynamic subtest: pipe-D-eDP-1 [551.916786] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [551.920915] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s) [554.104887] [139/155] (471s left) kms_ccs (missing-ccs-buffer-y-tiled-gen12-rc-ccs-cc) [554.207213] Starting subtest: missing-ccs-buffer-y-tiled-gen12-rc-ccs-cc [554.209466] Starting dynamic subtest: pipe-A-eDP-1 [554.231653] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [554.245043] Starting dynamic subtest: pipe-B-eDP-1 [554.265471] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [554.276723] Starting dynamic subtest: pipe-C-eDP-1 [554.297476] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [554.308474] Starting dynamic subtest: pipe-D-eDP-1 [554.331523] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [554.335595] Subtest missing-ccs-buffer-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s) [556.481964] [140/155] (469s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-shrfb-msflip-blt) [556.585644] Starting subtest: fbchdr-2p-primscrn-shrfb-msflip-blt [556.590266] Subtest fbchdr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s) [556.697321] [141/155] (469s left) kms_psr (psr-primary-blt) [556.798579] Starting subtest: psr-primary-blt [556.800717] Starting dynamic subtest: eDP-1 [558.577071] Dynamic subtest eDP-1: SUCCESS (1.779s) [558.579261] Subtest psr-primary-blt: SUCCESS (1.780s) [559.440005] [142/155] (466s left) kms_async_flips (async-flip-suspend-resume) [559.544521] Starting subtest: async-flip-suspend-resume [559.928107] Starting dynamic subtest: pipe-A-eDP-1 [577.549488] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.901s) [577.943047] Starting dynamic subtest: pipe-B-eDP-1 [595.559490] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.894s) [595.927949] Starting dynamic subtest: pipe-C-eDP-1 [613.539376] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.862s) [613.904516] Starting dynamic subtest: pipe-D-eDP-1 [631.551063] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.906s) [631.553310] Subtest async-flip-suspend-resume: SUCCESS (13.051s) [632.754806] [143/155] (393s left) kms_frontbuffer_tracking (hdr-2p-primscrn-shrfb-pgflip-blt) [632.853415] Starting subtest: hdr-2p-primscrn-shrfb-pgflip-blt [632.857570] Subtest hdr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s) [632.952852] [144/155] (393s left) gem_ctx_param (invalid-get-no-zeromap) [633.012338] Starting subtest: invalid-get-no-zeromap [633.014765] Subtest invalid-get-no-zeromap: SUCCESS (0.001s) [633.158421] [145/155] (392s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-pri-shrfb-draw-blt) [633.259681] Starting subtest: psrhdr-2p-scndscrn-pri-shrfb-draw-blt [633.263857] Subtest psrhdr-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s) [633.349585] [146/155] (392s left) gem_softpin (invalid) [633.401743] Starting subtest: invalid [633.410719] Subtest invalid: SUCCESS (0.006s) [633.535659] [147/155] (392s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-cur-indfb-draw-mmap-wc) [633.639197] Starting subtest: fbchdr-2p-scndscrn-cur-indfb-draw-mmap-wc [633.643417] Subtest fbchdr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [633.745733] [148/155] (392s left) kms_plane (plane-position-hole-dpms) [633.837617] Starting subtest: plane-position-hole-dpms [634.373778] Starting dynamic subtest: pipe-A-plane-1 [636.671485] Dynamic subtest pipe-A-plane-1: SUCCESS (2.293s) [636.683325] Starting dynamic subtest: pipe-A-plane-2 [639.041847] Dynamic subtest pipe-A-plane-2: SUCCESS (2.367s) [639.054515] Starting dynamic subtest: pipe-A-plane-3 [641.434909] Dynamic subtest pipe-A-plane-3: SUCCESS (2.389s) [641.447797] Starting dynamic subtest: pipe-A-plane-4 [643.831535] Dynamic subtest pipe-A-plane-4: SUCCESS (2.393s) [643.844132] Starting dynamic subtest: pipe-A-plane-5 [643.861839] Dynamic subtest pipe-A-plane-5: SUCCESS (0.027s) [645.089353] Starting dynamic subtest: pipe-B-plane-1 [647.415381] Dynamic subtest pipe-B-plane-1: SUCCESS (2.334s) [647.428911] Starting dynamic subtest: pipe-B-plane-2 [649.778687] Dynamic subtest pipe-B-plane-2: SUCCESS (2.359s) [649.792240] Starting dynamic subtest: pipe-B-plane-3 [652.163234] Dynamic subtest pipe-B-plane-3: SUCCESS (2.384s) [652.176847] Starting dynamic subtest: pipe-B-plane-4 [654.536505] Dynamic subtest pipe-B-plane-4: SUCCESS (2.370s) [654.549068] Starting dynamic subtest: pipe-B-plane-5 [654.564549] Dynamic subtest pipe-B-plane-5: SUCCESS (0.026s) [654.566884] Subtest plane-position-hole-dpms: SUCCESS (20.701s) [655.362562] [149/155] (370s left) syncobj_eventfd (invalid-bad-flags) [655.417934] Starting subtest: invalid-bad-flags [655.420121] Subtest invalid-bad-flags: SUCCESS (0.000s) [655.514321] [150/155] (370s left) sriov_basic (enable-vfs-autoprobe-on) [655.567345] Starting subtest: enable-vfs-autoprobe-on [655.569808] Starting dynamic subtest: numvfs-1 [655.574744] Dynamic subtest numvfs-1: SKIP (0.001s) [655.588364] Starting dynamic subtest: numvfs-2 [655.592784] Dynamic subtest numvfs-2: SKIP (0.001s) [655.604009] Starting dynamic subtest: numvfs-3 [655.608417] Dynamic subtest numvfs-3: SKIP (0.001s) [655.619616] Starting dynamic subtest: numvfs-4 [655.623855] Dynamic subtest numvfs-4: SKIP (0.001s) [655.635020] Starting dynamic subtest: numvfs-5 [655.639435] Dynamic subtest numvfs-5: SKIP (0.001s) [655.650647] Starting dynamic subtest: numvfs-6 [655.655134] Dynamic subtest numvfs-6: SKIP (0.001s) [655.668307] Starting dynamic subtest: numvfs-7 [655.672364] Dynamic subtest numvfs-7: SKIP (0.001s) [655.683225] Starting dynamic subtest: numvfs-random [655.687348] Dynamic subtest numvfs-random: SKIP (0.001s) [655.698005] Starting dynamic subtest: numvfs-all [655.702266] Dynamic subtest numvfs-all: SKIP (0.001s) [655.706391] Subtest enable-vfs-autoprobe-on: SKIP (0.011s) [655.746634] [151/155] (370s left) kms_flip (flip-vs-rmfb-interruptible) [655.833497] Starting subtest: flip-vs-rmfb-interruptible [655.835821] Starting dynamic subtest: A-eDP1 [664.520093] Dynamic subtest A-eDP1: SUCCESS (8.684s) [664.534998] Starting dynamic subtest: B-eDP1 [673.147948] Dynamic subtest B-eDP1: SUCCESS (8.629s) [673.161120] Starting dynamic subtest: C-eDP1 [681.805701] Dynamic subtest C-eDP1: SUCCESS (8.657s) [681.817539] Starting dynamic subtest: D-eDP1 [690.405084] Dynamic subtest D-eDP1: SUCCESS (8.597s) [690.409966] Subtest flip-vs-rmfb-interruptible: SUCCESS (34.576s) [691.603774] [152/155] (334s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-pri-indfb-draw-pwrite) [691.705880] Starting subtest: fbchdr-1p-primscrn-pri-indfb-draw-pwrite [691.709854] Subtest fbchdr-1p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s) [691.800291] [153/155] (334s left) kms_frontbuffer_tracking (fbcpsrhdr-rgb565-draw-render) [691.900093] Starting subtest: fbcpsrhdr-rgb565-draw-render [691.904238] Subtest fbcpsrhdr-rgb565-draw-render: SKIP (0.000s) [691.996884] [154/155] (334s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-cpu) [692.096431] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-cpu [696.118394] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (4.027s) [697.271010] [155/155] (329s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu) [697.371382] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu [704.547945] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (7.181s) [704.676511] Closing watchdogs results: parsing output: 0/ for test: kms_rotation_crc results: parsing output: 1/ for test: sysfs_heartbeat_interval results: parsing output: 2/ for test: gem_exec_params results: parsing output: 3/ for test: kms_draw_crc results: parsing output: 4/ for test: kms_big_fb results: parsing output: 5/ for test: gem_exec_params results: parsing output: 6/ for test: kms_frontbuffer_tracking results: parsing output: 7/ for test: kms_frontbuffer_tracking results: parsing output: 8/ for test: kms_frontbuffer_tracking results: parsing output: 9/ for test: gem_exec_whisper results: parsing output: 10/ for test: gem_mmap results: parsing output: 11/ for test: gen7_exec_parse results: parsing output: 12/ for test: kms_cursor_legacy results: parsing output: 13/ for test: gem_softpin results: parsing output: 14/ for test: kms_flip_scaled_crc results: parsing output: 15/ for test: kms_frontbuffer_tracking results: parsing output: 16/ for test: kms_frontbuffer_tracking results: parsing output: 17/ for test: kms_plane_cursor results: parsing output: 18/ for test: kms_frontbuffer_tracking results: parsing output: 19/ for test: gem_ctx_persistence results: parsing output: 20/ for test: kms_big_fb results: parsing output: 21/ for test: syncobj_timeline results: parsing output: 22/ for test: kms_color results: parsing output: 23/ for test: kms_flip results: parsing output: 24/ for test: kms_frontbuffer_tracking results: parsing output: 25/ for test: perf_pmu results: parsing output: 26/ for test: kms_getfb results: parsing output: 27/ for test: kms_frontbuffer_tracking results: parsing output: 28/ for test: kms_pm_dc results: parsing output: 29/ for test: gem_exec_reloc results: parsing output: 30/ for test: kms_flip results: parsing output: 31/ for test: kms_frontbuffer_tracking results: parsing output: 32/ for test: kms_properties results: parsing output: 33/ for test: kms_big_fb results: parsing output: 34/ for test: kms_frontbuffer_tracking results: parsing output: 35/ for test: kms_chamelium_hpd results: parsing output: 36/ for test: i915_drm_fdinfo results: parsing output: 37/ for test: gem_exec_params results: parsing output: 38/ for test: gem_spin_batch results: parsing output: 39/ for test: kms_big_fb results: parsing output: 40/ for test: kms_big_fb results: parsing output: 41/ for test: kms_ccs results: parsing output: 42/ for test: kms_frontbuffer_tracking results: parsing output: 43/ for test: kms_flip_scaled_crc results: parsing output: 44/ for test: gem_exec_fence results: parsing output: 45/ for test: kms_frontbuffer_tracking results: parsing output: 46/ for test: kms_cursor_crc results: parsing output: 47/ for test: prime_mmap_coherency results: parsing output: 48/ for test: sw_sync results: parsing output: 49/ for test: gem_userptr_blits results: parsing output: 50/ for test: gem_ctx_param results: parsing output: 51/ for test: kms_frontbuffer_tracking results: parsing output: 52/ for test: gem_mmap_gtt results: parsing output: 53/ for test: kms_cdclk results: parsing output: 54/ for test: kms_frontbuffer_tracking results: parsing output: 55/ for test: gem_gpgpu_fill results: parsing output: 56/ for test: gem_render_copy results: parsing output: 57/ for test: gem_exec_schedule results: parsing output: 58/ for test: gem_mmap_gtt results: parsing output: 59/ for test: i915_pm_rpm results: parsing output: 60/ for test: kms_lease results: parsing output: 61/ for test: kms_psr2_sf results: parsing output: 62/ for test: kms_frontbuffer_tracking results: parsing output: 63/ for test: kms_frontbuffer_tracking results: parsing output: 64/ for test: kms_vrr results: parsing output: 65/ for test: i915_suspend results: parsing output: 66/ for test: kms_frontbuffer_tracking results: parsing output: 67/ for test: kms_cursor_crc results: parsing output: 68/ for test: kms_vblank results: parsing output: 69/ for test: kms_cursor_crc results: parsing output: 70/ for test: kms_frontbuffer_tracking results: parsing output: 71/ for test: kms_busy results: parsing output: 72/ for test: gem_exec_reloc results: parsing output: 73/ for test: fbdev results: parsing output: 74/ for test: kms_chamelium_frames results: parsing output: 75/ for test: kms_frontbuffer_tracking results: parsing output: 76/ for test: kms_frontbuffer_tracking results: parsing output: 77/ for test: kms_flip results: parsing output: 78/ for test: syncobj_timeline results: parsing output: 79/ for test: perf results: parsing output: 80/ for test: prime_mmap_kms results: parsing output: 81/ for test: kms_frontbuffer_tracking results: parsing output: 82/ for test: gem_mmap_wc results: parsing output: 83/ for test: gem_ppgtt results: parsing output: 84/ for test: kms_rotation_crc results: parsing output: 85/ for test: syncobj_wait results: parsing output: 86/ for test: gem_userptr_blits results: parsing output: 87/ for test: i915_pm_freq_api results: parsing output: 88/ for test: gem_exec_balancer results: parsing output: 89/ for test: kms_frontbuffer_tracking results: parsing output: 90/ for test: gem_exec_params results: parsing output: 91/ for test: kms_plane results: parsing output: 92/ for test: kms_frontbuffer_tracking results: parsing output: 93/ for test: gem_mmap results: parsing output: 94/ for test: api_intel_bb results: parsing output: 95/ for test: kms_frontbuffer_tracking results: parsing output: 96/ for test: kms_big_fb results: parsing output: 97/ for test: kms_lease results: parsing output: 98/ for test: device_reset results: parsing output: 99/ for test: kms_psr results: parsing output: 100/ for test: gem_mmap_wc results: parsing output: 101/ for test: gem_render_copy results: parsing output: 102/ for test: syncobj_timeline results: parsing output: 103/ for test: kms_frontbuffer_tracking results: parsing output: 104/ for test: kms_psr results: parsing output: 105/ for test: kms_plane results: parsing output: 106/ for test: kms_frontbuffer_tracking results: parsing output: 107/ for test: kms_big_fb results: parsing output: 108/ for test: gem_ctx_engines results: parsing output: 109/ for test: kms_frontbuffer_tracking results: parsing output: 110/ for test: kms_frontbuffer_tracking results: parsing output: 111/ for test: kms_frontbuffer_tracking results: parsing output: 112/ for test: gem_render_copy results: parsing output: 113/ for test: kms_frontbuffer_tracking results: parsing output: 114/ for test: kms_cursor_legacy results: parsing output: 115/ for test: gem_exec_fence results: parsing output: 116/ for test: kms_psr results: parsing output: 117/ for test: kms_flip results: parsing output: 118/ for test: kms_atomic_transition results: parsing output: 119/ for test: kms_dp_linktrain_fallback results: parsing output: 120/ for test: kms_ccs results: parsing output: 121/ for test: gem_exec_flush results: parsing output: 122/ for test: kms_frontbuffer_tracking results: parsing output: 123/ for test: api_intel_allocator results: parsing output: 124/ for test: syncobj_timeline results: parsing output: 125/ for test: kms_frontbuffer_tracking results: parsing output: 126/ for test: kms_psr results: parsing output: 127/ for test: gem_vm_create results: parsing output: 128/ for test: kms_pm_rpm results: parsing output: 129/ for test: gem_exec_flush results: parsing output: 130/ for test: kms_prop_blob results: parsing output: 131/ for test: kms_cursor_legacy results: parsing output: 132/ for test: kms_plane_scaling results: parsing output: 133/ for test: gem_exec_schedule results: parsing output: 134/ for test: kms_psr2_sf results: parsing output: 135/ for test: kms_hdr results: parsing output: 136/ for test: kms_content_protection results: parsing output: 137/ for test: kms_ccs results: parsing output: 138/ for test: kms_ccs results: parsing output: 139/ for test: kms_frontbuffer_tracking results: parsing output: 140/ for test: kms_psr results: parsing output: 141/ for test: kms_async_flips results: parsing output: 142/ for test: kms_frontbuffer_tracking results: parsing output: 143/ for test: gem_ctx_param results: parsing output: 144/ for test: kms_frontbuffer_tracking results: parsing output: 145/ for test: gem_softpin results: parsing output: 146/ for test: kms_frontbuffer_tracking results: parsing output: 147/ for test: kms_plane results: parsing output: 148/ for test: syncobj_eventfd results: parsing output: 149/ for test: sriov_basic results: parsing output: 150/ for test: kms_flip results: parsing output: 151/ for test: kms_frontbuffer_tracking results: parsing output: 152/ for test: kms_frontbuffer_tracking results: parsing output: 153/ for test: kms_frontbuffer_tracking results: parsing output: 154/ for test: kms_frontbuffer_tracking Done.