[94.659170] Initializing watchdogs [94.659363] /dev/watchdog0 [94.696233] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:3185 Intel Geminilake (Gen9) GeminiLake [UHD Graphics 600] [94.709514] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [94.716631] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [94.721476] [001/131] (960s left) kms_invalid_mode (bad-hsync-end) [95.300587] Starting subtest: bad-hsync-end [95.304909] Starting dynamic subtest: pipe-A-HDMI-A-1 [95.688175] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.408s) [95.716931] Starting dynamic subtest: pipe-A-HDMI-A-2 [95.718887] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.014s) [95.740224] Starting dynamic subtest: pipe-B-HDMI-A-1 [95.741130] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.002s) [95.803207] Starting dynamic subtest: pipe-B-HDMI-A-2 [95.839248] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.001s) [95.861237] Starting dynamic subtest: pipe-C-HDMI-A-1 [95.863171] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.004s) [95.881429] Starting dynamic subtest: pipe-C-HDMI-A-2 [95.882335] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.002s) [95.883226] Subtest bad-hsync-end: SUCCESS (0.462s) [96.036252] [002/131] (959s left) kms_big_fb (yf-tiled-64bpp-rotate-0) [96.253559] Starting subtest: yf-tiled-64bpp-rotate-0 [96.257944] Subtest yf-tiled-64bpp-rotate-0: SKIP (0.000s) [96.368682] [003/131] (958s left) kms_addfb_basic (invalid-set-prop-any) [96.483779] Starting subtest: invalid-set-prop-any [96.486756] Subtest invalid-set-prop-any: SUCCESS (0.000s) [96.701690] [004/131] (958s left) syncobj_wait (multi-wait-all-submitted-signaled) [96.814981] Starting subtest: multi-wait-all-submitted-signaled [96.921867] Subtest multi-wait-all-submitted-signaled: SUCCESS (0.103s) [97.043846] [005/131] (958s left) kms_cursor_crc (cursor-sliding-128x42) [97.253816] Starting subtest: cursor-sliding-128x42 [97.315122] Starting dynamic subtest: pipe-A-HDMI-A-1 [101.415129] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (4.098s) [101.496878] Starting dynamic subtest: pipe-C-HDMI-A-1 [105.239422] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (3.742s) [105.240429] Subtest cursor-sliding-128x42: SUCCESS (7.982s) [105.524730] [006/131] (950s left) kms_addfb_basic (addfb25-yf-tiled-legacy) [105.726890] Starting subtest: addfb25-yf-tiled-legacy [105.728390] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s) [105.856142] [007/131] (949s left) kms_ccs (crc-primary-suspend-4-tiled-lnl-ccs) [106.047834] Starting subtest: crc-primary-suspend-4-tiled-lnl-ccs [106.094808] Subtest crc-primary-suspend-4-tiled-lnl-ccs: SKIP (0.000s) [106.671726] [008/131] (949s left) gem_exec_reloc (basic-wc-cpu-active) [106.809683] Starting subtest: basic-wc-cpu-active [106.952284] Subtest basic-wc-cpu-active: SUCCESS (0.140s) [107.154948] [009/131] (948s left) kms_rotation_crc (multiplane-rotation) [107.351440] Starting subtest: multiplane-rotation [172.359065] Subtest multiplane-rotation: SUCCESS (65.001s) [172.763737] [010/131] (883s left) gem_userptr_blits (set-cache-level) [172.900578] Starting subtest: set-cache-level [172.901622] Subtest set-cache-level: SUCCESS (0.001s) [173.093904] [011/131] (882s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-5) [173.298710] Starting subtest: planes-unity-scaling-downscale-factor-0-5 [173.300483] Starting dynamic subtest: pipe-A [173.674140] Dynamic subtest pipe-A: SUCCESS (0.381s) [173.700187] Starting dynamic subtest: pipe-B [174.085258] Dynamic subtest pipe-B: SUCCESS (0.405s) [174.112427] Starting dynamic subtest: pipe-C [174.166649] Dynamic subtest pipe-C: SUCCESS (0.072s) [174.167607] Subtest planes-unity-scaling-downscale-factor-0-5: SUCCESS (0.872s) [174.597934] [012/131] (881s left) gem_exec_flush (basic-wb-ro-default) [174.740086] Starting subtest: basic-wb-ro-default [180.171986] Subtest basic-wb-ro-default: SUCCESS (5.434s) [180.416758] [013/131] (875s left) kms_psr (psr2-primary-mmap-cpu) [180.620150] Subtest psr2-primary-mmap-cpu: SKIP (0.000s) [180.712099] [014/131] (875s left) kms_getfb (getfb2-handle-closed) [180.824355] Starting subtest: getfb2-handle-closed [180.826214] Subtest getfb2-handle-closed: SUCCESS (0.000s) [180.965265] [015/131] (875s left) kms_writeback (writeback-pixel-formats) [181.158347] Subtest writeback-pixel-formats: SKIP (0.000s) [181.259813] [016/131] (875s left) kms_color (ctm-red-to-blue) [181.457760] Starting subtest: ctm-red-to-blue [181.458732] Starting dynamic subtest: pipe-A-HDMI-A-1 [182.431126] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.975s) [182.446048] Starting dynamic subtest: pipe-A-HDMI-A-2 [183.124063] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.683s) [183.157733] Starting dynamic subtest: pipe-B-HDMI-A-1 [183.781362] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.664s) [183.796725] Starting dynamic subtest: pipe-B-HDMI-A-2 [184.474628] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.685s) [184.510524] Starting dynamic subtest: pipe-C-HDMI-A-1 [185.138300] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.662s) [185.154425] Starting dynamic subtest: pipe-C-HDMI-A-2 [185.797364] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.662s) [185.804550] Subtest ctm-red-to-blue: SUCCESS (4.344s) [186.074870] [017/131] (870s left) kms_big_fb (x-tiled-16bpp-rotate-270) [186.305213] Starting subtest: x-tiled-16bpp-rotate-270 [186.613632] Subtest x-tiled-16bpp-rotate-270: SKIP (0.308s) [186.845499] [018/131] (869s left) perf (missing-sample-flags) [187.063705] Starting subtest: missing-sample-flags [187.069857] Subtest missing-sample-flags: SUCCESS (0.003s) [187.165963] [019/131] (869s left) kms_fence_pin_leak [190.519937] [020/131] (866s left) gem_softpin (allocator-basic-reserve) [190.650861] Starting subtest: allocator-basic-reserve [190.852068] Subtest allocator-basic-reserve: SUCCESS (0.190s) [191.011724] [021/131] (865s left) gem_exec_reloc (basic-gtt-active) [191.142689] Starting subtest: basic-gtt-active [191.277308] Subtest basic-gtt-active: SUCCESS (0.136s) [191.503572] [022/131] (865s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-pwrite) [191.736761] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-pwrite [191.741552] Subtest psr-1p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [191.870233] [023/131] (865s left) gem_gpgpu_fill (offset-16x16) [191.993903] Starting subtest: offset-16x16 [192.004864] Subtest offset-16x16: SUCCESS (0.012s) [192.142912] [024/131] (864s left) api_intel_bb (add-remove-objects) [192.260114] Starting subtest: add-remove-objects [192.273405] Subtest add-remove-objects: SUCCESS (0.013s) [192.407807] [025/131] (864s left) kms_big_fb (y-tiled-addfb-size-offset-overflow) [192.624841] Starting subtest: y-tiled-addfb-size-offset-overflow [192.626564] Subtest y-tiled-addfb-size-offset-overflow: SUCCESS (0.000s) [192.752761] [026/131] (864s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-downscaling) [192.955967] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-downscaling [192.959681] Starting dynamic subtest: pipe-A-valid-mode [193.332934] Dynamic subtest pipe-A-valid-mode: SKIP (0.374s) [193.336552] Subtest flip-64bpp-yftile-to-16bpp-yftile-downscaling: SKIP (0.379s) [193.594504] [027/131] (863s left) kms_psr (psr-cursor-mmap-gtt) [193.801132] Subtest psr-cursor-mmap-gtt: SKIP (0.000s) [193.895571] [028/131] (863s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt) [194.122305] Starting subtest: psr-rgb565-draw-mmap-gtt [194.126305] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s) [194.259312] [029/131] (863s left) i915_pm_rpm (gem-idle) [196.216792] Starting subtest: gem-idle [201.425683] Subtest gem-idle: SUCCESS (5.210s) [201.736212] [030/131] (855s left) gem_exec_reloc (basic-write-gtt-active) [201.873997] Starting subtest: basic-write-gtt-active [202.008616] Subtest basic-write-gtt-active: SUCCESS (0.132s) [202.233211] [031/131] (855s left) gem_eio (in-flight-10ms) [202.393814] Starting subtest: in-flight-10ms [203.428100] Subtest in-flight-10ms: SUCCESS (1.031s) [203.675534] [FACT gem_eio (in-flight-10ms)] new: kernel.kmod_is_loaded.vgem: true [203.682323] [032/131] (853s left) gem_exec_params (sol-reset-invalid) [203.806241] Starting subtest: sol-reset-invalid [203.811964] Subtest sol-reset-invalid: SUCCESS (0.004s) [203.968868] [033/131] (853s left) kms_cursor_legacy (flip-vs-cursor-atomic) [204.171671] Starting subtest: flip-vs-cursor-atomic [220.949151] Subtest flip-vs-cursor-atomic: SUCCESS (16.775s) [221.248474] [034/131] (836s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-rc-ccs) [221.446349] Starting subtest: ccs-on-another-bo-y-tiled-gen12-rc-ccs [221.451743] Starting dynamic subtest: pipe-A-HDMI-A-1 [221.464724] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s) [221.536621] Starting dynamic subtest: pipe-A-HDMI-A-2 [221.546237] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.000s) [221.568511] Starting dynamic subtest: pipe-B-HDMI-A-1 [221.596402] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s) [221.612421] Starting dynamic subtest: pipe-B-HDMI-A-2 [221.620315] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.001s) [221.636236] Starting dynamic subtest: pipe-C-HDMI-A-1 [221.643631] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s) [221.661042] Starting dynamic subtest: pipe-C-HDMI-A-2 [221.672086] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.000s) [221.673699] Subtest ccs-on-another-bo-y-tiled-gen12-rc-ccs: SKIP (0.051s) [222.400974] [035/131] (835s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-render) [222.624292] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-render [222.626227] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s) [222.771960] [036/131] (835s left) kms_flip (2x-plain-flip) [222.976072] Starting subtest: 2x-plain-flip [222.981270] Starting dynamic subtest: AB-HDMI-A1-HDMI-A2 [224.409287] Dynamic subtest AB-HDMI-A1-HDMI-A2: SUCCESS (1.426s) [224.440926] Starting dynamic subtest: AC-HDMI-A1-HDMI-A2 [225.791829] Dynamic subtest AC-HDMI-A1-HDMI-A2: SUCCESS (1.374s) [225.816115] Starting dynamic subtest: BC-HDMI-A1-HDMI-A2 [227.145180] Dynamic subtest BC-HDMI-A1-HDMI-A2: SUCCESS (1.338s) [227.146339] Subtest 2x-plain-flip: SUCCESS (4.170s) [227.736885] [037/131] (830s left) kms_plane_scaling (plane-downscale-factor-0-5-with-rotation) [227.942378] Starting subtest: plane-downscale-factor-0-5-with-rotation [227.943312] Starting dynamic subtest: pipe-A [231.739083] Dynamic subtest pipe-A: SKIP (3.790s) [231.756330] Starting dynamic subtest: pipe-B [235.501900] Dynamic subtest pipe-B: SKIP (3.764s) [235.519082] Starting dynamic subtest: pipe-C [239.271151] Dynamic subtest pipe-C: SKIP (3.767s) [239.274692] Subtest plane-downscale-factor-0-5-with-rotation: SKIP (11.328s) [239.732850] [038/131] (818s left) gem_exec_params (invalid-fence-in-submit) [239.905615] Starting subtest: invalid-fence-in-submit [239.916300] Subtest invalid-fence-in-submit: SUCCESS (0.009s) [240.075418] [039/131] (818s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-gtt) [240.304714] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-gtt [240.306335] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [240.460107] [040/131] (817s left) kms_3d [246.413390] [041/131] (812s left) gem_mmap (basic-small-bo) [246.536614] Starting subtest: basic-small-bo [248.308365] Subtest basic-small-bo: SUCCESS (1.774s) [248.480885] [042/131] (810s left) kms_addfb_basic (too-high) [248.782974] Starting subtest: too-high [248.784236] Subtest too-high: SUCCESS (0.002s) [248.936919] [043/131] (809s left) fbdev (pan) [249.049397] Starting subtest: pan [249.101197] Subtest pan: SUCCESS (0.052s) [249.242361] [044/131] (809s left) kms_prop_blob (blob-prop-lifetime) [249.359818] Starting subtest: blob-prop-lifetime [249.365922] Subtest blob-prop-lifetime: SUCCESS (0.004s) [249.509093] [045/131] (809s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-render) [249.734918] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-render [252.384336] Subtest fbc-2p-primscrn-spr-indfb-draw-render: SUCCESS (2.649s) [252.608306] [046/131] (806s left) kms_cursor_legacy (cursor-vs-flip-legacy) [252.822568] Starting subtest: cursor-vs-flip-legacy [291.464121] Subtest cursor-vs-flip-legacy: SUCCESS (38.637s) [291.738361] [047/131] (767s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted) [291.868810] Starting subtest: etime-multi-wait-for-submit-unsubmitted [291.975824] Subtest etime-multi-wait-for-submit-unsubmitted: SUCCESS (0.106s) [292.124625] [048/131] (766s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-onoff) [292.345310] Starting subtest: psr-2p-scndscrn-cur-indfb-onoff [292.347146] Subtest psr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s) [292.503721] [049/131] (766s left) gem_exec_schedule (semaphore-user) [292.653727] Starting subtest: semaphore-user [292.670615] Subtest semaphore-user: SUCCESS (0.015s) [293.076793] [050/131] (766s left) drm_fdinfo (isolation) [293.197383] Starting subtest: isolation [293.199818] Starting dynamic subtest: rcs0 [293.727061] Dynamic subtest rcs0: SUCCESS (0.529s) [293.748869] Starting dynamic subtest: bcs0 [294.268452] Dynamic subtest bcs0: SUCCESS (0.536s) [294.289797] Starting dynamic subtest: vcs0 [294.805688] Dynamic subtest vcs0: SUCCESS (0.533s) [294.827300] Starting dynamic subtest: vecs0 [295.338948] Dynamic subtest vecs0: SUCCESS (0.530s) [295.342404] Subtest isolation: SUCCESS (2.146s) [295.495988] [051/131] (763s left) kms_feature_discovery (psr2) [295.694330] Starting subtest: psr2 [295.697334] Subtest psr2: SKIP (0.001s) [295.840464] [052/131] (763s left) gem_flink_race (flink_close) [295.949647] Starting subtest: flink_close [300.984104] Subtest flink_close: SUCCESS (5.031s) [301.127030] [053/131] (758s left) kms_psr (fbc-pr-cursor-mmap-gtt) [301.321458] Subtest fbc-pr-cursor-mmap-gtt: SKIP (0.000s) [301.439488] [054/131] (758s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc) [301.659175] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc [301.662950] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.001s) [301.805113] [055/131] (757s left) gen7_exec_parse (chained-batch) [301.927944] Subtest chained-batch: SKIP (0.000s) [302.043884] [056/131] (757s left) sysfs_heartbeat_interval (nopreempt) [302.172235] Starting subtest: nopreempt [302.173256] Starting dynamic subtest: vecs0 [305.791750] Dynamic subtest vecs0: SUCCESS (3.614s) [305.826190] Starting dynamic subtest: vcs0 [309.407202] Dynamic subtest vcs0: SUCCESS (3.613s) [309.443219] Starting dynamic subtest: bcs0 [313.007152] Dynamic subtest bcs0: SUCCESS (3.597s) [313.042390] Starting dynamic subtest: rcs0 [316.735268] Dynamic subtest rcs0: SUCCESS (3.725s) [316.736208] Subtest nopreempt: SUCCESS (14.565s) [316.871947] [057/131] (743s left) prime_mmap (test_userptr) [316.992795] Starting subtest: test_userptr [316.994367] Starting dynamic subtest: test_userptr-smem [316.996241] Dynamic subtest test_userptr-smem: SUCCESS (0.001s) [316.997398] Subtest test_userptr: SUCCESS (0.004s) [317.143181] [058/131] (742s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu) [317.356746] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu [317.359767] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s) [317.505159] [059/131] (742s left) gem_ppgtt (blt-vs-render-ctxn) [317.628846] Starting subtest: blt-vs-render-ctxN [350.153362] Subtest blt-vs-render-ctxN: SUCCESS (32.519s) [350.316825] [060/131] (709s left) kms_pm_rpm (modeset-non-lpsp-stress) [352.386053] Starting subtest: modeset-non-lpsp-stress [358.066465] Subtest modeset-non-lpsp-stress: SUCCESS (5.679s) [358.397156] [061/131] (701s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip) [358.624984] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip [358.628494] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s) [358.766283] [062/131] (701s left) gem_tiling_max_stride [359.095142] [063/131] (701s left) gem_mmap_gtt (hang-user) [359.207221] Starting subtest: hang-user [374.123680] Subtest hang-user: SUCCESS (14.913s) [374.291448] [064/131] (686s left) gem_exec_schedule (preempt-queue-chain) [374.460517] Starting subtest: preempt-queue-chain [374.462053] Starting dynamic subtest: rcs0 [374.744061] Dynamic subtest rcs0: SUCCESS (0.283s) [374.767619] Starting dynamic subtest: bcs0 [375.040915] Dynamic subtest bcs0: SUCCESS (0.289s) [375.069732] Starting dynamic subtest: vcs0 [375.323188] Dynamic subtest vcs0: SUCCESS (0.280s) [375.343274] Starting dynamic subtest: vecs0 [375.619502] Dynamic subtest vecs0: SUCCESS (0.298s) [375.620562] Subtest preempt-queue-chain: SUCCESS (1.160s) [376.019924] [065/131] (684s left) syncobj_timeline (wait-any-complex) [376.133272] Starting subtest: wait-any-complex [376.204067] Subtest wait-any-complex: SUCCESS (0.067s) [376.356128] [066/131] (684s left) gem_exec_fence (syncobj-timeline-wait) [377.052042] Starting subtest: syncobj-timeline-wait [377.082224] Subtest syncobj-timeline-wait: SUCCESS (0.029s) [377.357526] [067/131] (683s left) kms_cursor_legacy (cursora-vs-flipa-atomic) [377.556062] Starting subtest: cursorA-vs-flipA-atomic [388.773840] Subtest cursorA-vs-flipA-atomic: SUCCESS (11.216s) [389.046235] [068/131] (671s left) gem_mmap_gtt (basic-short) [389.160141] Starting subtest: basic-short [389.211505] Subtest basic-short: SUCCESS (0.051s) [389.360626] [069/131] (671s left) kms_rotation_crc (primary-y-tiled-reflect-x-270) [389.563383] Starting subtest: primary-y-tiled-reflect-x-270 [389.565229] Subtest primary-y-tiled-reflect-x-270: SKIP (0.005s) [389.726466] [070/131] (671s left) gem_exec_balancer (bonded-sync) [389.871498] Starting subtest: bonded-sync [393.504623] Subtest bonded-sync: SUCCESS (3.634s) [393.763809] [071/131] (667s left) gem_mmap_wc (read-write-distinct) [393.877419] Starting subtest: read-write-distinct [393.908418] Subtest read-write-distinct: SUCCESS (0.031s) [394.068924] [072/131] (667s left) kms_cursor_crc (cursor-alpha-opaque) [394.264086] Starting subtest: cursor-alpha-opaque [394.270704] Starting dynamic subtest: pipe-A-HDMI-A-1 [395.198063] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.914s) [395.240402] Starting dynamic subtest: pipe-C-HDMI-A-1 [395.776772] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.561s) [395.777981] Subtest cursor-alpha-opaque: SUCCESS (1.489s) [396.050606] [073/131] (665s left) perf (non-zero-reason) [396.287793] Starting subtest: non-zero-reason [396.288824] Starting dynamic subtest: 0-rcs0 [446.849679] Dynamic subtest 0-rcs0: SUCCESS (50.561s) [446.853625] Subtest non-zero-reason: SUCCESS (50.565s) [446.964254] [074/131] (614s left) kms_big_fb (x-tiled-addfb) [447.182250] Starting subtest: x-tiled-addfb [447.183761] Subtest x-tiled-addfb: SUCCESS (0.001s) [447.332300] [075/131] (614s left) kms_vblank (ts-continuation-idle) [447.533716] Starting subtest: ts-continuation-idle [447.534557] Starting dynamic subtest: pipe-A-HDMI-A-1 [448.270930] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.705s) [448.307594] Starting dynamic subtest: pipe-A-HDMI-A-2 [448.650610] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.399s) [448.673947] Starting dynamic subtest: pipe-C-HDMI-A-1 [449.051237] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.386s) [449.091540] Starting dynamic subtest: pipe-C-HDMI-A-2 [449.427980] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.374s) [449.429454] Subtest ts-continuation-idle: SUCCESS (1.893s) [449.709275] [076/131] (611s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-blt) [449.944963] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-blt [449.947520] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s) [450.101675] [077/131] (611s left) syncobj_basic (test-valid-cycle) [450.215263] Starting subtest: test-valid-cycle [450.217939] Subtest test-valid-cycle: SUCCESS (0.000s) [450.358321] [078/131] (611s left) kms_cursor_crc (cursor-onscreen-256x256) [450.566394] Starting subtest: cursor-onscreen-256x256 [450.608858] Starting dynamic subtest: pipe-A-HDMI-A-1 [453.309637] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.697s) [453.427068] Starting dynamic subtest: pipe-C-HDMI-A-1 [455.764949] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (2.384s) [455.769371] Subtest cursor-onscreen-256x256: SUCCESS (5.192s) [456.062379] [079/131] (605s left) kms_psr (fbc-psr-cursor-mmap-cpu) [456.262162] Subtest fbc-psr-cursor-mmap-cpu: SKIP (0.000s) [456.379198] [080/131] (605s left) syncobj_timeline (reset-during-wait-for-submit) [456.497242] Starting subtest: reset-during-wait-for-submit [456.605076] Subtest reset-during-wait-for-submit: SUCCESS (0.106s) [456.752226] [081/131] (605s left) gem_eio (wait-1us) [456.900652] Starting subtest: wait-1us [457.004511] Subtest wait-1us: SUCCESS (0.107s) [457.243469] [082/131] (604s left) gem_exec_fence (long-history) [457.766283] Starting subtest: long-history [463.488281] Subtest long-history: SUCCESS (5.724s) [464.168393] [083/131] (598s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu) [464.392750] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu [464.395963] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [464.547296] [084/131] (597s left) kms_dp_link_training (non-uhbr-mst) [464.760792] Starting subtest: non-uhbr-mst [464.765957] Subtest non-uhbr-mst: SKIP (0.000s) [464.895465] [085/131] (597s left) gem_cs_tlb (engines) [465.022196] Starting subtest: engines [465.023118] Starting dynamic subtest: rcs0 [467.187881] Dynamic subtest rcs0: SUCCESS (2.163s) [467.214966] Starting dynamic subtest: bcs0 [469.356628] Dynamic subtest bcs0: SUCCESS (2.161s) [469.376287] Starting dynamic subtest: vcs0 [471.519930] Dynamic subtest vcs0: SUCCESS (2.160s) [471.540236] Starting dynamic subtest: vecs0 [473.682337] Dynamic subtest vecs0: SUCCESS (2.159s) [473.683325] Subtest engines: SUCCESS (8.657s) [473.833688] [086/131] (588s left) kms_chamelium_frames (hdmi-frame-dump) [474.411877] Subtest hdmi-frame-dump: SKIP (0.000s) [474.678505] [087/131] (588s left) perf (polling) [474.898338] Starting subtest: polling [474.899542] Starting dynamic subtest: 0-rcs0 [484.957041] Dynamic subtest 0-rcs0: SUCCESS (10.053s) [484.960370] Subtest polling: SUCCESS (10.056s) [485.056513] [088/131] (577s left) kms_psr2_sf (fbc-pr-overlay-plane-update-sf-dmg-area) [485.269709] Subtest fbc-pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s) [485.369976] [089/131] (577s left) kms_cursor_edge_walk (128x128-top-bottom) [485.582834] Starting subtest: 128x128-top-bottom [485.584858] Starting dynamic subtest: pipe-A-HDMI-A-1 [489.449067] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (3.860s) [489.481604] Starting dynamic subtest: pipe-C-HDMI-A-1 [492.901256] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (3.447s) [492.902245] Subtest 128x128-top-bottom: SUCCESS (7.322s) [493.256397] [090/131] (569s left) kms_ccs (bad-aux-stride-y-tiled-ccs) [493.465604] Starting subtest: bad-aux-stride-y-tiled-ccs [493.471637] Starting dynamic subtest: pipe-A-HDMI-A-1 [493.483976] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.005s) [493.525274] Starting dynamic subtest: pipe-A-HDMI-A-2 [493.555171] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.022s) [493.590868] Starting dynamic subtest: pipe-B-HDMI-A-1 [493.601757] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.003s) [493.623452] Starting dynamic subtest: pipe-B-HDMI-A-2 [493.631623] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.003s) [493.650118] Starting dynamic subtest: pipe-C-HDMI-A-1 [493.658174] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s) [493.676640] Starting dynamic subtest: pipe-C-HDMI-A-2 [493.684103] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.000s) [493.684958] Subtest bad-aux-stride-y-tiled-ccs: SUCCESS (0.068s) [494.439451] [091/131] (568s left) kms_cdclk (plane-scaling) [494.555889] Subtest plane-scaling: SKIP (0.000s) [494.656805] [092/131] (568s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-fullscreen) [494.864516] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-fullscreen [494.867733] Subtest fbcpsr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.001s) [495.021582] [093/131] (568s left) gem_ctx_persistence (legacy-engines-mixed-process) [495.145052] Starting subtest: legacy-engines-mixed-process [495.146197] Starting dynamic subtest: render [495.548138] Dynamic subtest render: SUCCESS (0.402s) [495.593194] Starting dynamic subtest: bsd [495.966600] Dynamic subtest bsd: SUCCESS (0.411s) [496.009399] Starting dynamic subtest: blt [496.350561] Dynamic subtest blt: SUCCESS (0.375s) [496.405893] Starting dynamic subtest: vebox [496.733733] Dynamic subtest vebox: SUCCESS (0.367s) [496.739040] Subtest legacy-engines-mixed-process: SUCCESS (1.588s) [496.910551] [094/131] (566s left) kms_atomic (atomic-invalid-params) [497.103556] Starting subtest: atomic-invalid-params [497.112504] Starting dynamic subtest: pipe-A-HDMI-A-1 [497.628281] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.515s) [497.670554] Subtest atomic-invalid-params: SUCCESS (0.521s) [497.893422] [095/131] (565s left) kms_psr2_sf (psr2-overlay-plane-update-sf-dmg-area) [498.105346] Subtest psr2-overlay-plane-update-sf-dmg-area: SKIP (0.000s) [498.214171] [096/131] (565s left) kms_mmap_write_crc (main) [498.431212] Starting subtest: main [498.437845] Starting dynamic subtest: pipe-A-HDMI-A-1 [501.975097] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (3.525s) [501.976058] Subtest main: SUCCESS (3.538s) [502.292357] [097/131] (561s left) prime_busy (hang) [502.429923] Starting subtest: hang [502.430986] Starting dynamic subtest: rcs0 [508.756049] Dynamic subtest rcs0: SUCCESS (6.325s) [508.777169] Starting dynamic subtest: bcs0 [515.730598] Dynamic subtest bcs0: SUCCESS (6.971s) [515.749282] Starting dynamic subtest: vcs0 [522.771338] Dynamic subtest vcs0: SUCCESS (7.035s) [522.789930] Starting dynamic subtest: vecs0 [529.747499] Dynamic subtest vecs0: SUCCESS (6.973s) [529.749582] Subtest hang: SUCCESS (27.320s) [529.900144] [098/131] (533s left) gem_ctx_param (invalid-get-engines) [530.012185] Starting subtest: invalid-get-engines [530.013635] Subtest invalid-get-engines: SUCCESS (0.000s) [530.167467] [099/131] (533s left) syncobj_basic (bad-create-flags) [530.282495] Starting subtest: bad-create-flags [530.284274] Subtest bad-create-flags: SUCCESS (0.000s) [530.425819] [100/131] (533s left) gem_exec_suspend (basic-s4-devices) [530.561356] Starting subtest: basic-S4-devices [530.562402] Starting dynamic subtest: smem [541.505379] Dynamic subtest smem: SUCCESS (10.940s) [541.506242] Subtest basic-S4-devices: SUCCESS (10.944s) [541.709071] Aborting: Lockdep not active /proc/lockdep_stats contents: lock-classes: 2210 [max: 8192] direct dependencies: 24810 [max: 524288] indirect dependencies: 197193 all direct dependencies: 542132 dependency chains: 36259 [max: 524288] dependency chain hlocks used: 152318 [max: 2621440] dependency chain hlocks lost: 0 in-hardirq chains: 318 in-softirq chains: 995 in-process chains: 34946 stack-trace entries: 254716 [max: 524288] number of stack traces: 12061 number of stack hash chains: 8505 combined max dependencies: 2513566036 hardirq-safe locks: 108 hardirq-unsafe locks: 1313 softirq-safe locks: 265 softirq-unsafe locks: 1205 irq-safe locks: 286 irq-unsafe locks: 1313 hardirq-read-safe locks: 6 hardirq-read-unsafe locks: 398 softirq-read-safe locks: 11 softirq-read-unsafe locks: 393 irq-read-safe locks: 11 irq-read-unsafe locks: 398 uncategorized locks: 351 unused locks: 1 max locking depth: 18 max bfs queue depth: 418 max lock class index: 2209 debug_locks: 0 zapped classes: 3 zapped lock chains: 162 large chain blocks: 1 [541.746338] Closing watchdogs results: parsing output: 0/ for test: kms_invalid_mode results: parsing output: 1/ for test: kms_big_fb results: parsing output: 2/ for test: kms_addfb_basic results: parsing output: 3/ for test: syncobj_wait results: parsing output: 4/ for test: kms_cursor_crc results: parsing output: 5/ for test: kms_addfb_basic results: parsing output: 6/ for test: kms_ccs results: parsing output: 7/ for test: gem_exec_reloc results: parsing output: 8/ for test: kms_rotation_crc results: parsing output: 9/ for test: gem_userptr_blits results: parsing output: 10/ for test: kms_plane_scaling results: parsing output: 11/ for test: gem_exec_flush results: parsing output: 12/ for test: kms_psr results: parsing output: 13/ for test: kms_getfb results: parsing output: 14/ for test: kms_writeback results: parsing output: 15/ for test: kms_color results: parsing output: 16/ for test: kms_big_fb results: parsing output: 17/ for test: perf results: parsing output: 18/ for test: kms_fence_pin_leak results: parsing output: 19/ for test: gem_softpin results: parsing output: 20/ for test: gem_exec_reloc results: parsing output: 21/ for test: kms_frontbuffer_tracking results: parsing output: 22/ for test: gem_gpgpu_fill results: parsing output: 23/ for test: api_intel_bb results: parsing output: 24/ for test: kms_big_fb results: parsing output: 25/ for test: kms_flip_scaled_crc results: parsing output: 26/ for test: kms_psr results: parsing output: 27/ for test: kms_frontbuffer_tracking results: parsing output: 28/ for test: i915_pm_rpm results: parsing output: 29/ for test: gem_exec_reloc results: parsing output: 30/ for test: gem_eio results: parsing output: 31/ for test: gem_exec_params results: parsing output: 32/ for test: kms_cursor_legacy results: parsing output: 33/ for test: kms_ccs results: parsing output: 34/ for test: kms_frontbuffer_tracking results: parsing output: 35/ for test: kms_flip results: parsing output: 36/ for test: kms_plane_scaling results: parsing output: 37/ for test: gem_exec_params results: parsing output: 38/ for test: kms_frontbuffer_tracking results: parsing output: 39/ for test: kms_3d results: parsing output: 40/ for test: gem_mmap results: parsing output: 41/ for test: kms_addfb_basic results: parsing output: 42/ for test: fbdev results: parsing output: 43/ for test: kms_prop_blob results: parsing output: 44/ for test: kms_frontbuffer_tracking results: parsing output: 45/ for test: kms_cursor_legacy results: parsing output: 46/ for test: syncobj_timeline results: parsing output: 47/ for test: kms_frontbuffer_tracking results: parsing output: 48/ for test: gem_exec_schedule results: parsing output: 49/ for test: drm_fdinfo results: parsing output: 50/ for test: kms_feature_discovery results: parsing output: 51/ for test: gem_flink_race results: parsing output: 52/ for test: kms_psr results: parsing output: 53/ for test: kms_frontbuffer_tracking results: parsing output: 54/ for test: gen7_exec_parse results: parsing output: 55/ for test: sysfs_heartbeat_interval results: parsing output: 56/ for test: prime_mmap results: parsing output: 57/ for test: kms_frontbuffer_tracking results: parsing output: 58/ for test: gem_ppgtt results: parsing output: 59/ for test: kms_pm_rpm results: parsing output: 60/ for test: kms_big_fb results: parsing output: 61/ for test: gem_tiling_max_stride results: parsing output: 62/ for test: gem_mmap_gtt results: parsing output: 63/ for test: gem_exec_schedule results: parsing output: 64/ for test: syncobj_timeline results: parsing output: 65/ for test: gem_exec_fence results: parsing output: 66/ for test: kms_cursor_legacy results: parsing output: 67/ for test: gem_mmap_gtt results: parsing output: 68/ for test: kms_rotation_crc results: parsing output: 69/ for test: gem_exec_balancer results: parsing output: 70/ for test: gem_mmap_wc results: parsing output: 71/ for test: kms_cursor_crc results: parsing output: 72/ for test: perf results: parsing output: 73/ for test: kms_big_fb results: parsing output: 74/ for test: kms_vblank results: parsing output: 75/ for test: kms_frontbuffer_tracking results: parsing output: 76/ for test: syncobj_basic results: parsing output: 77/ for test: kms_cursor_crc results: parsing output: 78/ for test: kms_psr results: parsing output: 79/ for test: syncobj_timeline results: parsing output: 80/ for test: gem_eio results: parsing output: 81/ for test: gem_exec_fence results: parsing output: 82/ for test: kms_frontbuffer_tracking results: parsing output: 83/ for test: kms_dp_link_training results: parsing output: 84/ for test: gem_cs_tlb results: parsing output: 85/ for test: kms_chamelium_frames results: parsing output: 86/ for test: perf results: parsing output: 87/ for test: kms_psr2_sf results: parsing output: 88/ for test: kms_cursor_edge_walk results: parsing output: 89/ for test: kms_ccs results: parsing output: 90/ for test: kms_cdclk results: parsing output: 91/ for test: kms_frontbuffer_tracking results: parsing output: 92/ for test: gem_ctx_persistence results: parsing output: 93/ for test: kms_atomic results: parsing output: 94/ for test: kms_psr2_sf results: parsing output: 95/ for test: kms_mmap_write_crc results: parsing output: 96/ for test: prime_busy results: parsing output: 97/ for test: gem_ctx_param results: parsing output: 98/ for test: syncobj_basic results: parsing output: 99/ for test: gem_exec_suspend results: parsing output: 100/ for test: core_setmaster_vs_auth results: no output, setting notrun results: parsing output: 101/ for test: gen3_mixed_blits results: no output, setting notrun results: parsing output: 102/ for test: kms_pm_backlight results: no output, setting notrun results: parsing output: 103/ for test: perf_pmu results: no output, setting notrun results: parsing output: 104/ for test: syncobj_timeline results: no output, setting notrun results: parsing output: 105/ for test: kms_flip_scaled_crc results: no output, setting notrun results: parsing output: 106/ for test: gem_render_copy results: no output, setting notrun results: parsing output: 107/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 108/ for test: gem_close_race results: no output, setting notrun results: parsing output: 109/ for test: kms_ccs results: no output, setting notrun results: parsing output: 110/ for test: kms_chamelium_color results: no output, setting notrun results: parsing output: 111/ for test: gen9_exec_parse results: no output, setting notrun results: parsing output: 112/ for test: kms_pipe_crc_basic results: no output, setting notrun results: parsing output: 113/ for test: syncobj_timeline results: no output, setting notrun results: parsing output: 114/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 115/ for test: gem_caching results: no output, setting notrun results: parsing output: 116/ for test: kms_flip results: no output, setting notrun results: parsing output: 117/ for test: api_intel_bb results: no output, setting notrun results: parsing output: 118/ for test: gem_exec_whisper results: no output, setting notrun results: parsing output: 119/ for test: gem_pxp results: no output, setting notrun results: parsing output: 120/ for test: kms_big_fb results: no output, setting notrun results: parsing output: 121/ for test: gem_mmap_offset results: no output, setting notrun results: parsing output: 122/ for test: kms_big_fb results: no output, setting notrun results: parsing output: 123/ for test: kms_rotation_crc results: no output, setting notrun results: parsing output: 124/ for test: kms_psr results: no output, setting notrun results: parsing output: 125/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 126/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 127/ for test: kms_frontbuffer_tracking results: no output, setting notrun results: parsing output: 128/ for test: gem_exec_balancer results: no output, setting notrun results: parsing output: 129/ for test: gem_set_tiling_vs_blt results: no output, setting notrun results: parsing output: 130/ for test: i915_hangman results: no output, setting notrun Done.