Result:
integration-manifest git-log-oneline i915_display_info2 igt_runner2 runtimes2 results2.json results2-i915-load.json guc_logs2.tar i915_display_info_post_exec2 boot2 dmesg2
| Detail | Value |
|---|---|
| Duration | 45.31 seconds |
| Hostname |
shard-rkl-8 |
| Igt-Version |
IGT-Version: 2.3-g531ebe060 (x86_64) (Linux: 7.0.0-rc5-CI_DRM_18207-g41579e12882a+ x86_64) |
| Out |
Using IGT_SRANDOM=1774442470 for randomisation Opened device: /dev/dri/card0 Using monotonic timestamps Starting subtest: plain-flip-ts-check Starting dynamic subtest: A-HDMI-A1 1920x1080: 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5 Expected frametime: 18974us; measured 18975.8us +- 7.253us accuracy 0.11% Event flip: expected 527, counted 527, passrate = 100.00%, encoder type 2 Dynamic subtest A-HDMI-A1: SUCCESS (10.502s) Starting dynamic subtest: B-HDMI-A1 1920x1080: 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5 Expected frametime: 18974us; measured 18975.0us +- 6.346us accuracy 0.10% Event flip: expected 527, counted 533, passrate = 53.28%, encoder type 2 Expected frametime: 18974us; measured 18771.9us +- 11.171us accuracy 0.18% vblank interval differs from modeline! expected 18973.8us, measured 18772us +- 11.171us, difference 201.9us (18.1 sigma) Event flip: expected 533, counted 531, passrate = 46.70%, encoder type 2 Stack trace: #0 ../lib/igt_core.c:2075 __igt_fail_assert() #1 ../tests/kms_flip.c:428 run_test_on_crtc_set.constprop.0() #2 ../tests/kms_flip.c:1891 run_test() #3 ../tests/kms_flip.c:2126 __igt_unique____real_main2047() #4 ../tests/kms_flip.c:2047 main() #5 [__libc_init_first+0x8a] #6 [__libc_start_main+0x8b] #7 [_start+0x25] Dynamic subtest B-HDMI-A1: FAIL (24.311s) Starting dynamic subtest: C-HDMI-A1 1920x1080: 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5 Expected frametime: 18974us; measured 18918.9us +- 8.876us accuracy 0.14% vblank interval differs from modeline! expected 18973.8us, measured 18919us +- 8.876us, difference 54.9us (6.2 sigma) Event flip: expected 528, counted 528, passrate = 100.00%, encoder type 2 Dynamic subtest C-HDMI-A1: SUCCESS (10.485s) Subtest plain-flip-ts-check: FAIL (45.306s) |
| Err |
Starting subtest: plain-flip-ts-check Starting dynamic subtest: A-HDMI-A1 Dynamic subtest A-HDMI-A1: SUCCESS (10.502s) Starting dynamic subtest: B-HDMI-A1 (kms_flip:2444) CRITICAL: Test assertion failure function __run_test_on_crtc_set, file ../tests/kms_flip.c:1711: (kms_flip:2444) CRITICAL: Failed assertion: !retried Dynamic subtest B-HDMI-A1 failed. **** DEBUG **** (kms_flip:2444) DEBUG: flip ts/seq: last 135.008621/1064, current 135.027512/1065: elapsed=18901.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.008621/1064, current 135.027512/1065: elapsed=18901.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.027512 last_received_ts = 135.027084 last_seq = 1065 current_ts = 135.046432 current_received_ts = 135.046082 current_seq = 1066 count = 451 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.027512/1065, current 135.046432/1066: elapsed=18916.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.027512/1065, current 135.046432/1066: elapsed=18916.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.046432 last_received_ts = 135.046082 last_seq = 1066 current_ts = 135.065323 current_received_ts = 135.064957 current_seq = 1067 count = 452 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.046432/1066, current 135.065323/1067: elapsed=18897.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.046432/1066, current 135.065323/1067: elapsed=18897.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.065323 last_received_ts = 135.064957 last_seq = 1067 current_ts = 135.084229 current_received_ts = 135.083817 current_seq = 1068 count = 453 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.065323/1067, current 135.084229/1068: elapsed=18906.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.065323/1067, current 135.084229/1068: elapsed=18906.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.084229 last_received_ts = 135.083817 last_seq = 1068 current_ts = 135.103149 current_received_ts = 135.102676 current_seq = 1069 count = 454 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.084229/1068, current 135.103149/1069: elapsed=18916.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.084229/1068, current 135.103149/1069: elapsed=18916.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.103149 last_received_ts = 135.102676 last_seq = 1069 current_ts = 135.122055 current_received_ts = 135.121582 current_seq = 1070 count = 455 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.103149/1069, current 135.122055/1070: elapsed=18896.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.103149/1069, current 135.122055/1070: elapsed=18896.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.122055 last_received_ts = 135.121582 last_seq = 1070 current_ts = 135.140945 current_received_ts = 135.140533 current_seq = 1071 count = 456 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.122055/1070, current 135.140945/1071: elapsed=18898.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.122055/1070, current 135.140945/1071: elapsed=18898.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.140945 last_received_ts = 135.140533 last_seq = 1071 current_ts = 135.159866 current_received_ts = 135.159332 current_seq = 1072 count = 457 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.140945/1071, current 135.159866/1072: elapsed=18914.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.140945/1071, current 135.159866/1072: elapsed=18914.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.159866 last_received_ts = 135.159332 last_seq = 1072 current_ts = 135.178772 current_received_ts = 135.178360 current_seq = 1073 count = 458 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.159866/1072, current 135.178772/1073: elapsed=18909.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.159866/1072, current 135.178772/1073: elapsed=18909.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.178772 last_received_ts = 135.178360 last_seq = 1073 current_ts = 135.197678 current_received_ts = 135.197266 current_seq = 1074 count = 459 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.178772/1073, current 135.197678/1074: elapsed=18903.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.178772/1073, current 135.197678/1074: elapsed=18903.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.197678 last_received_ts = 135.197266 last_seq = 1074 current_ts = 135.216583 current_received_ts = 135.216156 current_seq = 1075 count = 460 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.197678/1074, current 135.216583/1075: elapsed=18910.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.197678/1074, current 135.216583/1075: elapsed=18910.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.216583 last_received_ts = 135.216156 last_seq = 1075 current_ts = 135.235474 current_received_ts = 135.235123 current_seq = 1076 count = 461 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.216583/1075, current 135.235474/1076: elapsed=18891.0us expected=18771.9us +- 93.9us, error 0.6% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.216583/1075, current 135.235474/1076: elapsed=18891.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.235474 last_received_ts = 135.235123 last_seq = 1076 current_ts = 135.254395 current_received_ts = 135.254059 current_seq = 1077 count = 462 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.235474/1076, current 135.254395/1077: elapsed=18919.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.235474/1076, current 135.254395/1077: elapsed=18919.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.254395 last_received_ts = 135.254059 last_seq = 1077 current_ts = 135.273285 current_received_ts = 135.272858 current_seq = 1078 count = 463 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.254395/1077, current 135.273285/1078: elapsed=18897.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.254395/1077, current 135.273285/1078: elapsed=18897.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.273285 last_received_ts = 135.272858 last_seq = 1078 current_ts = 135.292191 current_received_ts = 135.291718 current_seq = 1079 count = 464 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.273285/1078, current 135.292191/1079: elapsed=18900.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.273285/1078, current 135.292191/1079: elapsed=18900.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.292191 last_received_ts = 135.291718 last_seq = 1079 current_ts = 135.311111 current_received_ts = 135.310608 current_seq = 1080 count = 465 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.292191/1079, current 135.311111/1080: elapsed=18918.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.292191/1079, current 135.311111/1080: elapsed=18918.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.311111 last_received_ts = 135.310608 last_seq = 1080 current_ts = 135.330002 current_received_ts = 135.329590 current_seq = 1081 count = 466 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.311111/1080, current 135.330002/1081: elapsed=18891.0us expected=18771.9us +- 93.9us, error 0.6% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.311111/1080, current 135.330002/1081: elapsed=18891.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.330002 last_received_ts = 135.329590 last_seq = 1081 current_ts = 135.348907 current_received_ts = 135.348389 current_seq = 1082 count = 467 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.330002/1081, current 135.348907/1082: elapsed=18917.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.330002/1081, current 135.348907/1082: elapsed=18917.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.348907 last_received_ts = 135.348389 last_seq = 1082 current_ts = 135.367813 current_received_ts = 135.367416 current_seq = 1083 count = 468 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.348907/1082, current 135.367813/1083: elapsed=18905.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.348907/1082, current 135.367813/1083: elapsed=18905.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.367813 last_received_ts = 135.367416 last_seq = 1083 current_ts = 135.386719 current_received_ts = 135.386307 current_seq = 1084 count = 469 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.367813/1083, current 135.386719/1084: elapsed=18901.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.367813/1083, current 135.386719/1084: elapsed=18901.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.386719 last_received_ts = 135.386307 last_seq = 1084 current_ts = 135.405624 current_received_ts = 135.405151 current_seq = 1085 count = 470 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.386719/1084, current 135.405624/1085: elapsed=18898.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.386719/1084, current 135.405624/1085: elapsed=18898.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.405624 last_received_ts = 135.405151 last_seq = 1085 current_ts = 135.424530 current_received_ts = 135.424133 current_seq = 1086 count = 471 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.405624/1085, current 135.424530/1086: elapsed=18910.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.405624/1085, current 135.424530/1086: elapsed=18910.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.424530 last_received_ts = 135.424133 last_seq = 1086 current_ts = 135.443436 current_received_ts = 135.443085 current_seq = 1087 count = 472 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.424530/1086, current 135.443436/1087: elapsed=18902.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.424530/1086, current 135.443436/1087: elapsed=18902.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.443436 last_received_ts = 135.443085 last_seq = 1087 current_ts = 135.462357 current_received_ts = 135.461929 current_seq = 1088 count = 473 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.443436/1087, current 135.462357/1088: elapsed=18918.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.443436/1087, current 135.462357/1088: elapsed=18918.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.462357 last_received_ts = 135.461929 last_seq = 1088 current_ts = 135.481247 current_received_ts = 135.480713 current_seq = 1089 count = 474 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.462357/1088, current 135.481247/1089: elapsed=18905.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.462357/1088, current 135.481247/1089: elapsed=18905.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.481247 last_received_ts = 135.480713 last_seq = 1089 current_ts = 135.500168 current_received_ts = 135.499725 current_seq = 1090 count = 475 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.481247/1089, current 135.500168/1090: elapsed=18916.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.481247/1089, current 135.500168/1090: elapsed=18916.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.500168 last_received_ts = 135.499725 last_seq = 1090 current_ts = 135.519073 current_received_ts = 135.518539 current_seq = 1091 count = 476 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.500168/1090, current 135.519073/1091: elapsed=18910.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.500168/1090, current 135.519073/1091: elapsed=18910.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.519073 last_received_ts = 135.518539 last_seq = 1091 current_ts = 135.537994 current_received_ts = 135.537491 current_seq = 1092 count = 477 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.519073/1091, current 135.537994/1092: elapsed=18915.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.519073/1091, current 135.537994/1092: elapsed=18915.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.537994 last_received_ts = 135.537491 last_seq = 1092 current_ts = 135.556900 current_received_ts = 135.556503 current_seq = 1093 count = 478 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.537994/1092, current 135.556900/1093: elapsed=18907.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.537994/1092, current 135.556900/1093: elapsed=18907.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.556900 last_received_ts = 135.556503 last_seq = 1093 current_ts = 135.575806 current_received_ts = 135.575302 current_seq = 1094 count = 479 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.556900/1093, current 135.575806/1094: elapsed=18911.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.556900/1093, current 135.575806/1094: elapsed=18911.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.575806 last_received_ts = 135.575302 last_seq = 1094 current_ts = 135.594742 current_received_ts = 135.594330 current_seq = 1095 count = 480 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.575806/1094, current 135.594742/1095: elapsed=18924.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.575806/1094, current 135.594742/1095: elapsed=18924.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.594742 last_received_ts = 135.594330 last_seq = 1095 current_ts = 135.613647 current_received_ts = 135.613235 current_seq = 1096 count = 481 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.594742/1095, current 135.613647/1096: elapsed=18909.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.594742/1095, current 135.613647/1096: elapsed=18909.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.613647 last_received_ts = 135.613235 last_seq = 1096 current_ts = 135.632553 current_received_ts = 135.632095 current_seq = 1097 count = 482 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.613647/1096, current 135.632553/1097: elapsed=18910.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.613647/1096, current 135.632553/1097: elapsed=18910.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.632553 last_received_ts = 135.632095 last_seq = 1097 current_ts = 135.651474 current_received_ts = 135.651093 current_seq = 1098 count = 483 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.632553/1097, current 135.651474/1098: elapsed=18915.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.632553/1097, current 135.651474/1098: elapsed=18915.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.651474 last_received_ts = 135.651093 last_seq = 1098 current_ts = 135.670380 current_received_ts = 135.670044 current_seq = 1099 count = 484 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.651474/1098, current 135.670380/1099: elapsed=18905.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.651474/1098, current 135.670380/1099: elapsed=18905.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.670380 last_received_ts = 135.670044 last_seq = 1099 current_ts = 135.689285 current_received_ts = 135.688828 current_seq = 1100 count = 485 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.670380/1099, current 135.689285/1100: elapsed=18914.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.670380/1099, current 135.689285/1100: elapsed=18914.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.689285 last_received_ts = 135.688828 last_seq = 1100 current_ts = 135.708206 current_received_ts = 135.707748 current_seq = 1101 count = 486 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.689285/1100, current 135.708206/1101: elapsed=18914.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.689285/1100, current 135.708206/1101: elapsed=18914.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.708206 last_received_ts = 135.707748 last_seq = 1101 current_ts = 135.727112 current_received_ts = 135.726654 current_seq = 1102 count = 487 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.708206/1101, current 135.727112/1102: elapsed=18905.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.708206/1101, current 135.727112/1102: elapsed=18905.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.727112 last_received_ts = 135.726654 last_seq = 1102 current_ts = 135.746033 current_received_ts = 135.745560 current_seq = 1103 count = 488 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.727112/1102, current 135.746033/1103: elapsed=18929.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.727112/1102, current 135.746033/1103: elapsed=18929.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.746033 last_received_ts = 135.745560 last_seq = 1103 current_ts = 135.764938 current_received_ts = 135.764526 current_seq = 1104 count = 489 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.746033/1103, current 135.764938/1104: elapsed=18897.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.746033/1103, current 135.764938/1104: elapsed=18897.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.764938 last_received_ts = 135.764526 last_seq = 1104 current_ts = 135.783859 current_received_ts = 135.783447 current_seq = 1105 count = 490 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.764938/1104, current 135.783859/1105: elapsed=18925.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.764938/1104, current 135.783859/1105: elapsed=18925.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.783859 last_received_ts = 135.783447 last_seq = 1105 current_ts = 135.802765 current_received_ts = 135.802277 current_seq = 1106 count = 491 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.783859/1105, current 135.802765/1106: elapsed=18904.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.783859/1105, current 135.802765/1106: elapsed=18904.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.802765 last_received_ts = 135.802277 last_seq = 1106 current_ts = 135.821686 current_received_ts = 135.821167 current_seq = 1107 count = 492 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.802765/1106, current 135.821686/1107: elapsed=18915.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.802765/1106, current 135.821686/1107: elapsed=18915.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.821686 last_received_ts = 135.821167 last_seq = 1107 current_ts = 135.840591 current_received_ts = 135.840164 current_seq = 1108 count = 493 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.821686/1107, current 135.840591/1108: elapsed=18917.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.821686/1107, current 135.840591/1108: elapsed=18917.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.840591 last_received_ts = 135.840164 last_seq = 1108 current_ts = 135.859512 current_received_ts = 135.859116 current_seq = 1109 count = 494 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.840591/1108, current 135.859512/1109: elapsed=18915.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.840591/1108, current 135.859512/1109: elapsed=18915.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.859512 last_received_ts = 135.859116 last_seq = 1109 current_ts = 135.878418 current_received_ts = 135.878067 current_seq = 1110 count = 495 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.859512/1109, current 135.878418/1110: elapsed=18900.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.859512/1109, current 135.878418/1110: elapsed=18900.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.878418 last_received_ts = 135.878067 last_seq = 1110 current_ts = 135.897324 current_received_ts = 135.896942 current_seq = 1111 count = 496 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.878418/1110, current 135.897324/1111: elapsed=18911.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.878418/1110, current 135.897324/1111: elapsed=18911.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.897324 last_received_ts = 135.896942 last_seq = 1111 current_ts = 135.916229 current_received_ts = 135.915771 current_seq = 1112 count = 497 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.897324/1111, current 135.916229/1112: elapsed=18912.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.897324/1111, current 135.916229/1112: elapsed=18912.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.916229 last_received_ts = 135.915771 last_seq = 1112 current_ts = 135.935150 current_received_ts = 135.934723 current_seq = 1113 count = 498 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.916229/1112, current 135.935150/1113: elapsed=18913.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.916229/1112, current 135.935150/1113: elapsed=18913.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.935150 last_received_ts = 135.934723 last_seq = 1113 current_ts = 135.954071 current_received_ts = 135.953583 current_seq = 1114 count = 499 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.935150/1113, current 135.954071/1114: elapsed=18921.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.935150/1113, current 135.954071/1114: elapsed=18921.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.954071 last_received_ts = 135.953583 last_seq = 1114 current_ts = 135.972977 current_received_ts = 135.972519 current_seq = 1115 count = 500 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.954071/1114, current 135.972977/1115: elapsed=18915.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.954071/1114, current 135.972977/1115: elapsed=18915.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.972977 last_received_ts = 135.972519 last_seq = 1115 current_ts = 135.991882 current_received_ts = 135.991470 current_seq = 1116 count = 501 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.972977/1115, current 135.991882/1116: elapsed=18904.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.972977/1115, current 135.991882/1116: elapsed=18904.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 135.991882 last_received_ts = 135.991470 last_seq = 1116 current_ts = 136.010803 current_received_ts = 136.010269 current_seq = 1117 count = 502 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 135.991882/1116, current 136.010803/1117: elapsed=18916.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 135.991882/1116, current 136.010803/1117: elapsed=18916.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.010803 last_received_ts = 136.010269 last_seq = 1117 current_ts = 136.029724 current_received_ts = 136.029251 current_seq = 1118 count = 503 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.010803/1117, current 136.029724/1118: elapsed=18919.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.010803/1117, current 136.029724/1118: elapsed=18919.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.029724 last_received_ts = 136.029251 last_seq = 1118 current_ts = 136.048630 current_received_ts = 136.048141 current_seq = 1119 count = 504 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.029724/1118, current 136.048630/1119: elapsed=18911.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.029724/1118, current 136.048630/1119: elapsed=18911.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.048630 last_received_ts = 136.048141 last_seq = 1119 current_ts = 136.067535 current_received_ts = 136.067169 current_seq = 1120 count = 505 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.048630/1119, current 136.067535/1120: elapsed=18909.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.048630/1119, current 136.067535/1120: elapsed=18909.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.067535 last_received_ts = 136.067169 last_seq = 1120 current_ts = 136.086456 current_received_ts = 136.085922 current_seq = 1121 count = 506 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.067535/1120, current 136.086456/1121: elapsed=18912.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.067535/1120, current 136.086456/1121: elapsed=18912.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.086456 last_received_ts = 136.085922 last_seq = 1121 current_ts = 136.105362 current_received_ts = 136.104828 current_seq = 1122 count = 507 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.086456/1121, current 136.105362/1122: elapsed=18906.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.086456/1121, current 136.105362/1122: elapsed=18906.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.105362 last_received_ts = 136.104828 last_seq = 1122 current_ts = 136.124283 current_received_ts = 136.123749 current_seq = 1123 count = 508 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.105362/1122, current 136.124283/1123: elapsed=18919.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.105362/1122, current 136.124283/1123: elapsed=18919.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.124283 last_received_ts = 136.123749 last_seq = 1123 current_ts = 136.143188 current_received_ts = 136.142715 current_seq = 1124 count = 509 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.124283/1123, current 136.143188/1124: elapsed=18906.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.124283/1123, current 136.143188/1124: elapsed=18906.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.143188 last_received_ts = 136.142715 last_seq = 1124 current_ts = 136.162109 current_received_ts = 136.161591 current_seq = 1125 count = 510 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.143188/1124, current 136.162109/1125: elapsed=18922.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.143188/1124, current 136.162109/1125: elapsed=18922.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.162109 last_received_ts = 136.161591 last_seq = 1125 current_ts = 136.181015 current_received_ts = 136.180557 current_seq = 1126 count = 511 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.162109/1125, current 136.181015/1126: elapsed=18913.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.162109/1125, current 136.181015/1126: elapsed=18913.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.181015 last_received_ts = 136.180557 last_seq = 1126 current_ts = 136.199921 current_received_ts = 136.199509 current_seq = 1127 count = 512 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.181015/1126, current 136.199921/1127: elapsed=18905.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.181015/1126, current 136.199921/1127: elapsed=18905.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.199921 last_received_ts = 136.199509 last_seq = 1127 current_ts = 136.218842 current_received_ts = 136.218430 current_seq = 1128 count = 513 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.199921/1127, current 136.218842/1128: elapsed=18917.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.199921/1127, current 136.218842/1128: elapsed=18917.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.218842 last_received_ts = 136.218430 last_seq = 1128 current_ts = 136.237747 current_received_ts = 136.237228 current_seq = 1129 count = 514 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.218842/1128, current 136.237747/1129: elapsed=18912.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.218842/1128, current 136.237747/1129: elapsed=18912.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.237747 last_received_ts = 136.237228 last_seq = 1129 current_ts = 136.256668 current_received_ts = 136.256165 current_seq = 1130 count = 515 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.237747/1129, current 136.256668/1130: elapsed=18917.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.237747/1129, current 136.256668/1130: elapsed=18917.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.256668 last_received_ts = 136.256165 last_seq = 1130 current_ts = 136.275574 current_received_ts = 136.275162 current_seq = 1131 count = 516 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.256668/1130, current 136.275574/1131: elapsed=18902.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.256668/1130, current 136.275574/1131: elapsed=18902.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.275574 last_received_ts = 136.275162 last_seq = 1131 current_ts = 136.294479 current_received_ts = 136.294113 current_seq = 1132 count = 517 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.275574/1131, current 136.294479/1132: elapsed=18913.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.275574/1131, current 136.294479/1132: elapsed=18913.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.294479 last_received_ts = 136.294113 last_seq = 1132 current_ts = 136.313400 current_received_ts = 136.313065 current_seq = 1133 count = 518 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.294479/1132, current 136.313400/1133: elapsed=18909.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.294479/1132, current 136.313400/1133: elapsed=18909.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.313400 last_received_ts = 136.313065 last_seq = 1133 current_ts = 136.332321 current_received_ts = 136.331940 current_seq = 1134 count = 519 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.313400/1133, current 136.332321/1134: elapsed=18926.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.313400/1133, current 136.332321/1134: elapsed=18926.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.332321 last_received_ts = 136.331940 last_seq = 1134 current_ts = 136.351242 current_received_ts = 136.350815 current_seq = 1135 count = 520 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.332321/1134, current 136.351242/1135: elapsed=18914.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.332321/1134, current 136.351242/1135: elapsed=18914.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.351242 last_received_ts = 136.350815 last_seq = 1135 current_ts = 136.370148 current_received_ts = 136.369720 current_seq = 1136 count = 521 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.351242/1135, current 136.370148/1136: elapsed=18911.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.351242/1135, current 136.370148/1136: elapsed=18911.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.370148 last_received_ts = 136.369720 last_seq = 1136 current_ts = 136.389053 current_received_ts = 136.388519 current_seq = 1137 count = 522 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.370148/1136, current 136.389053/1137: elapsed=18906.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.370148/1136, current 136.389053/1137: elapsed=18906.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.389053 last_received_ts = 136.388519 last_seq = 1137 current_ts = 136.407974 current_received_ts = 136.407562 current_seq = 1138 count = 523 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.389053/1137, current 136.407974/1138: elapsed=18915.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.389053/1137, current 136.407974/1138: elapsed=18915.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.407974 last_received_ts = 136.407562 last_seq = 1138 current_ts = 136.426865 current_received_ts = 136.426483 current_seq = 1139 count = 524 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.407974/1138, current 136.426865/1139: elapsed=18905.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.407974/1138, current 136.426865/1139: elapsed=18905.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.426865 last_received_ts = 136.426483 last_seq = 1139 current_ts = 136.445801 current_received_ts = 136.445267 current_seq = 1140 count = 525 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.426865/1139, current 136.445801/1140: elapsed=18923.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.426865/1139, current 136.445801/1140: elapsed=18923.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.445801 last_received_ts = 136.445267 last_seq = 1140 current_ts = 136.464706 current_received_ts = 136.464294 current_seq = 1141 count = 526 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.445801/1140, current 136.464706/1141: elapsed=18913.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.445801/1140, current 136.464706/1141: elapsed=18913.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.464706 last_received_ts = 136.464294 last_seq = 1141 current_ts = 136.483627 current_received_ts = 136.483215 current_seq = 1142 count = 527 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.464706/1141, current 136.483627/1142: elapsed=18924.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.464706/1141, current 136.483627/1142: elapsed=18924.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.483627 last_received_ts = 136.483215 last_seq = 1142 current_ts = 136.502548 current_received_ts = 136.502106 current_seq = 1143 count = 528 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.483627/1142, current 136.502548/1143: elapsed=18918.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.483627/1142, current 136.502548/1143: elapsed=18918.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.502548 last_received_ts = 136.502106 last_seq = 1143 current_ts = 136.521454 current_received_ts = 136.521118 current_seq = 1144 count = 529 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.502548/1143, current 136.521454/1144: elapsed=18909.0us expected=18771.9us +- 93.9us, error 0.7% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.502548/1143, current 136.521454/1144: elapsed=18909.0us expected=18771.9us (kms_flip:2444) DEBUG: name = flip last_ts = 136.521454 last_received_ts = 136.521118 last_seq = 1144 current_ts = 136.540375 current_received_ts = 136.539841 current_seq = 1145 count = 530 seq_step = 1 (kms_flip:2444) DEBUG: flip ts/seq: last 136.521454/1144, current 136.540375/1145: elapsed=18923.0us expected=18771.9us +- 93.9us, error 0.8% (kms_flip:2444) DEBUG: inconsistent flip ts/seq: last 136.521454/1144, current 136.540375/1145: elapsed=18923.0us expected=18771.9us (kms_flip:2444) INFO: Event flip: expected 533, counted 531, passrate = 46.70%, encoder type 2 (kms_flip:2444) DEBUG: dropped frames, expected 533, counted 531, passrate = 46.70%, encoder type 2 (kms_flip:2444) CRITICAL: Test assertion failure function __run_test_on_crtc_set, file ../tests/kms_flip.c:1711: (kms_flip:2444) CRITICAL: Failed assertion: !retried (kms_flip:2444) igt_core-INFO: Stack trace: (kms_flip:2444) igt_core-INFO: #0 ../lib/igt_core.c:2075 __igt_fail_assert() (kms_flip:2444) igt_core-INFO: #1 ../tests/kms_flip.c:428 run_test_on_crtc_set.constprop.0() (kms_flip:2444) igt_core-INFO: #2 ../tests/kms_flip.c:1891 run_test() (kms_flip:2444) igt_core-INFO: #3 ../tests/kms_flip.c:2126 __igt_unique____real_main2047() (kms_flip:2444) igt_core-INFO: #4 ../tests/kms_flip.c:2047 main() (kms_flip:2444) igt_core-INFO: #5 [__libc_init_first+0x8a] (kms_flip:2444) igt_core-INFO: #6 [__libc_start_main+0x8b] (kms_flip:2444) igt_core-INFO: #7 [_start+0x25] **** END **** Dynamic subtest B-HDMI-A1: FAIL (24.311s) Starting dynamic subtest: C-HDMI-A1 Dynamic subtest C-HDMI-A1: SUCCESS (10.485s) Subtest plain-flip-ts-check: FAIL (45.306s) |
| Dmesg |
<6> [116.767385] Console: switching to colour dummy device 80x25
<6> [116.767443] [IGT] kms_flip: executing
<7> [116.770895] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [116.771460] i915 0000:00:02.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x000001dc [0x000001dc]
<7> [116.771705] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [116.775940] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:400:HDMI-A-2]
<7> [116.775947] i915 0000:00:02.0: [drm:intel_hdmi_detect [i915]] [CONNECTOR:400:HDMI-A-2]
<7> [116.780172] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:400:HDMI-A-2] disconnected
<7> [116.780423] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:404:DP-1]
<7> [116.780427] i915 0000:00:02.0: [drm:intel_dp_detect [i915]] [CONNECTOR:404:DP-1]
<7> [116.784615] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:404:DP-1] disconnected
<7> [116.784864] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:412:HDMI-A-3]
<7> [116.784884] i915 0000:00:02.0: [drm:intel_hdmi_detect [i915]] [CONNECTOR:412:HDMI-A-3]
<7> [116.789096] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:412:HDMI-A-3] disconnected
<7> [116.789395] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:390:HDMI-A-1]
<7> [116.789401] i915 0000:00:02.0: [drm:intel_hdmi_detect [i915]] [CONNECTOR:390:HDMI-A-1]
<7> [116.818980] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:390:HDMI-A-1] Supported Monitor Refresh rate range is 0 Hz - 0 Hz
<7> [116.818993] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:390:HDMI-A-1] Assigning EDID-1.4 digital sink color depth as 8 bpc.
<7> [116.818997] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:390:HDMI-A-1] ELD monitor fitHeadless4k
<7> [116.819000] i915 0000:00:02.0: [drm:update_display_info.part.0] [CONNECTOR:390:HDMI-A-1] ELD size 36, SAD count 0
<7> [116.821305] i915 0000:00:02.0: [drm:drm_dp_dual_mode_detect [drm_display_helper]] DP dual mode HDMI ID: DP-HDMI ADAPTOR\004 (err 0)
<7> [116.823719] i915 0000:00:02.0: [drm:drm_dp_dual_mode_detect [drm_display_helper]] DP dual mode adaptor ID: a0 (err 0)
<7> [116.827518] i915 0000:00:02.0: [drm:intel_hdmi_set_edid [i915]] DP dual mode adaptor (type 2 HDMI) detected (max TMDS clock: 600000 kHz)
<7> [116.827675] i915 0000:00:02.0: [drm:intel_hdmi_set_edid [i915]] Ignoring DP dual mode adaptor max TMDS clock for native HDMI port
<7> [116.828212] i915 0000:00:02.0: [drm:drm_mode_prune_invalid] Rejected mode: "1366x768": 216 268000 1366 1414 1446 1526 768 771 777 814 0x40 0x6 (CLOCK_HIGH)
<7> [116.828220] i915 0000:00:02.0: [drm:drm_mode_prune_invalid] Rejected mode: "1920x1080i": 60 74250 1920 2008 2052 2200 1080 1084 1094 1125 0x40 0x15 (NO_INTERLACE)
<7> [116.828225] i915 0000:00:02.0: [drm:drm_mode_prune_invalid] Rejected mode: "1920x1080i": 60 74176 1920 2008 2052 2200 1080 1084 1094 1125 0x40 0x15 (NO_INTERLACE)
<7> [116.828231] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:390:HDMI-A-1] probed modes:
<7> [116.828235] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1920x1080": 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5
<7> [116.828238] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "4088x2304": 10 108000 4088 4152 4280 4536 2304 2305 2308 2340 0x40 0x5
<7> [116.828240] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "3840x2160": 15 128430 3840 3889 3921 4000 2160 2163 2169 2195 0x40 0xa
<7> [116.828243] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "2880x1800": 11 60000 2880 2888 2984 3040 1800 1802 1820 1845 0x40 0xa
<7> [116.828245] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "2560x1600": 13 60000 2560 2568 2664 2720 1600 1602 1620 1645 0x40 0xa
<7> [116.828248] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "2560x1440": 15 60000 2560 2568 2664 2720 1440 1442 1460 1485 0x40 0xa
<7> [116.828251] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "2048x1536": 17 60000 2048 2056 2152 2208 1536 1538 1556 1581 0x40 0xa
<7> [116.828253] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1600x1200": 60 162000 1600 1664 1856 2160 1200 1201 1204 1250 0x40 0x5
<7> [116.828256] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1680x1050": 60 146250 1680 1784 1960 2240 1050 1053 1059 1089 0x40 0x6
<7> [116.828258] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1600x900": 60 108000 1600 1624 1704 1800 900 901 904 1000 0x40 0x5
<7> [116.828261] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x1024": 75 135000 1280 1296 1440 1688 1024 1025 1028 1066 0x40 0x5
<7> [116.828264] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1360x768": 60 84963 1366 1431 1567 1776 768 771 781 798 0x0 0x6
<7> [116.828266] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1360x768": 20 25190 1360 1368 1464 1520 768 770 788 813 0x40 0xa
<7> [116.828269] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x800": 60 83500 1280 1352 1480 1680 800 803 809 831 0x40 0x6
<7> [116.828272] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1152x864": 75 108000 1152 1216 1344 1600 864 865 868 900 0x40 0x5
<7> [116.828274] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x720": 60 74250 1280 1390 1430 1650 720 725 730 750 0x40 0x5
<7> [116.828277] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x720": 60 74250 1280 1390 1430 1650 720 725 730 750 0x40 0x5
<7> [116.828279] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1280x720": 60 74176 1280 1390 1430 1650 720 725 730 750 0x40 0x5
<7> [116.828282] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1024x768": 75 78750 1024 1040 1136 1312 768 769 772 800 0x40 0x5
<7> [116.828284] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1024x768": 60 65000 1024 1048 1184 1344 768 771 777 806 0x40 0xa
<7> [116.828287] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1440x480": 60 54054 1440 1472 1596 1716 480 489 495 525 0x40 0xa
<7> [116.828289] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1440x480": 60 54000 1440 1472 1596 1716 480 489 495 525 0x40 0xa
<7> [116.828292] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "1024x576": 60 46560 1024 1064 1160 1296 576 579 584 599 0x0 0x6
<7> [116.828295] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "832x624": 75 57284 832 864 928 1152 624 625 628 667 0x40 0xa
<7> [116.828297] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "800x600": 75 49500 800 816 896 1056 600 601 604 625 0x40 0x5
<7> [116.828300] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "800x600": 60 40000 800 840 968 1056 600 601 605 628 0x40 0x5
<7> [116.828302] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 75 31500 640 656 720 840 480 481 484 500 0x40 0xa
<7> [116.828305] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 60 25200 640 656 752 800 480 490 492 525 0x40 0xa
<7> [116.828308] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 60 25175 640 656 752 800 480 490 492 525 0x40 0xa
<7> [116.828310] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "640x480": 60 25175 640 656 752 800 480 490 492 525 0x40 0xa
<7> [116.828313] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] Probed mode: "720x400": 70 28320 720 738 846 900 400 412 414 449 0x40 0x6
<7> [116.828337] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:400:HDMI-A-2]
<7> [116.828340] i915 0000:00:02.0: [drm:intel_hdmi_detect [i915]] [CONNECTOR:400:HDMI-A-2]
<7> [116.832527] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:400:HDMI-A-2] disconnected
<7> [116.832542] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:404:DP-1]
<7> [116.832545] i915 0000:00:02.0: [drm:intel_dp_detect [i915]] [CONNECTOR:404:DP-1]
<7> [116.836760] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:404:DP-1] disconnected
<7> [116.836773] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:412:HDMI-A-3]
<7> [116.836776] i915 0000:00:02.0: [drm:intel_hdmi_detect [i915]] [CONNECTOR:412:HDMI-A-3]
<7> [116.841038] i915 0000:00:02.0: [drm:drm_helper_probe_single_connector_modes] [CONNECTOR:412:HDMI-A-3] disconnected
<6> [116.841447] [IGT] kms_flip: starting subtest plain-flip-ts-check
<6> [116.842750] [IGT] kms_flip: starting dynamic subtest A-HDMI-A1
<7> [116.843134] i915 0000:00:02.0: [drm:drm_mode_addfb2] [FB:417]
<7> [116.843211] i915 0000:00:02.0: [drm:drm_mode_addfb2] [FB:419]
<7> [116.886023] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:151:pipe A]
<7> [116.886143] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.enable (expected yes, found no)
<7> [116.886360] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.active (expected yes, found no)
<7> [116.886551] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in cpu_transcoder (expected 0, found -1)
<7> [116.886738] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in lane_count (expected 4, found 0)
<7> [116.886947] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in output_types (expected 0x00000040, found 0x00000000)
<7> [116.887148] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [116.887342] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 1920, found 0)
<7> [116.887540] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 2360, found 0)
<7> [116.887794] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 1920, found 0)
<7> [116.888017] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 2360, found 0)
<7> [116.888215] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2008, found 0)
<7> [116.888413] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2096, found 0)
<7> [116.888598] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1080, found 0)
<7> [116.888826] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1080, found 0)
<7> [116.889032] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1084, found 0)
<7> [116.889229] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1089, found 0)
<7> [116.889416] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1125, found 0)
<7> [116.889609] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1125, found 0)
<7> [116.889799] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 1920, found 0)
<7> [116.890048] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 2360, found 0)
<7> [116.890238] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 1920, found 0)
<7> [116.890426] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 2360, found 0)
<7> [116.890597] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2008, found 0)
<7> [116.890740] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2096, found 0)
<7> [116.890902] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1080, found 0)
<7> [116.891075] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1080, found 0)
<7> [116.891238] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1084, found 0)
<7> [116.891390] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1089, found 0)
<7> [116.891545] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1125, found 0)
<7> [116.891702] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1125, found 0)
<7> [116.891869] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [116.892016] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 1, found 0)
<7> [116.892206] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 4, found 0)
<7> [116.892352] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in pipe_bpp (expected 24, found 0)
<7> [116.892505] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 139929, found 0)
<7> [116.892649] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 139929, found 0)
<7> [116.892801] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in port_clock (expected 139929, found 0)
<7> [116.892971] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:151:pipe A] fastset requirement not met, forcing full modeset
<7> [116.893149] i915 0000:00:02.0: [drm:intel_dpll_crtc_put [i915]] [CRTC:151:pipe A] releasing DPLL 0
<7> [116.893330] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] Enabled dbuf slices 0x3 -> 0x1 (total dbuf slices 0x3), mbus joined? no->no
<7> [116.893483] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:151:pipe A] dbuf slices 0x3 -> 0x0, ddb (0 - 2048) -> (0 - 0), active pipes 0x1 -> 0x0
<7> [116.893660] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:35:plane 1A] ddb ( 0 - 2016) -> ( 0 - 0), size 2016 -> 0
<7> [116.893820] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:145:cursor A] ddb (2016 - 2048) -> ( 0 - 0), size 32 -> 0
<7> [116.893948] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] level *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm -> wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm
<7> [116.894080] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] lines 1, 2, 2, 2, 2, 5, 8, 9, 0, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [116.894238] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] blocks 16, 33, 33, 33, 33, 81, 129, 145, 30, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [116.894365] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] min_ddb 19, 38, 38, 38, 38, 91, 143, 161, 31, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [116.894515] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] [CRTC:151:pipe A] data rate 0 num active planes 0
<7> [116.894648] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] QGV point 0: max bw 16761 required 0
<7> [116.894803] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:151:pipe A] min cdclk: 69965 kHz -> 0 kHz
<7> [116.894971] i915 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [i915]] dbuf bandwidth min cdclk: 8746 kHz -> 0 kHz
<7> [116.895130] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:151:pipe A] enable: no [modeset]
<7> [116.895274] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:35:plane 1A] fb: [NOFB], visible: no
<7> [116.895406] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:65:plane 2A] fb: [NOFB], visible: no
<7> [116.895545] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:95:plane 3A] fb: [NOFB], visible: no
<7> [116.895675] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:125:plane 4A] fb: [NOFB], visible: no
<7> [116.895822] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:135:plane 5A] fb: [NOFB], visible: no
<7> [116.895952] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:145:cursor A] fb: [NOFB], visible: no
<7> [116.896166] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling DC_off
<7> [116.896303] i915 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [i915]] Setting DC state from 02 to 00
<7> [116.896792] i915 0000:00:02.0: [drm:intel_disable_transcoder [i915]] disabling pipe A
<7> [116.916006] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling DDI_IO_B
<7> [116.916270] i915 0000:00:02.0: [drm:intel_dp_dual_mode_set_tmds_output [i915]] Disabling DP dual mode adaptor TMDS output
<7> [116.921104] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disable DPLL 0 (active 0x1, on? 1) for [CRTC:151:pipe A]
<7> [116.921370] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disabling DPLL 0
<7> [116.921617] i915 0000:00:02.0: [drm:__intel_fbc_disable [i915]] Disabling FBC on [PLANE:35:plane 1A]
<7> [116.921874] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:389:DDI B/PHY B]
<7> [116.922125] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:399:DDI TC1/PHY C]
<7> [116.922406] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:403:DDI TC2/PHY D]
<7> [116.922630] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:405:DP-MST A]
<7> [116.922888] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:406:DP-MST B]
<7> [116.923124] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:407:DP-MST C]
<7> [116.923355] i915 0000:00:02.0: [drm:verify_connector_state [i915]] [CONNECTOR:390:HDMI-A-1]
<7> [116.923646] i915 0000:00:02.0: [drm:gen9_dbuf_slices_update [i915]] Updating dbuf slices to 0x1
<7> [116.923902] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:151:pipe A]
<7> [116.924411] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:269:pipe B]
<7> [116.924604] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:387:pipe C]
<7> [116.924746] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:151:pipe A]
<7> [116.924773] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CONNECTOR:390:HDMI-A-1]
<7> [116.924869] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CONNECTOR:390:HDMI-A-1] Limiting target display pipe bpp to 24 (EDID bpp 24, max requested bpp 36, max platform bpp 36)
<7> [116.925061] i915 0000:00:02.0: [drm:intel_hdmi_compute_clock [i915]] picking 8 bpc for HDMI output (pipe bpp: 24)
<7> [116.925227] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:151:pipe A] hw max bpp: 24, pipe bpp: 24, dithering: 0
<7> [116.925405] i915 0000:00:02.0: [drm:intel_ddi_compute_config_late [i915]] [ENCODER:389:DDI B/PHY B] [CRTC:151:pipe A]
<7> [116.925605] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.enable (expected no, found yes)
<7> [116.925777] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.active (expected no, found yes)
<7> [116.925982] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in cpu_transcoder (expected -1, found 0)
<7> [116.926161] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in lane_count (expected 0, found 4)
<7> [116.926330] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in output_types (expected 0x00000000, found 0x00000040)
<7> [116.926499] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in framestart_delay (expected 0, found 1)
<7> [116.926676] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 0, found 1920)
<7> [116.926879] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 0, found 2360)
<7> [116.927009] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 0, found 1920)
<7> [116.927146] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 0, found 2360)
<7> [116.927276] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 0, found 2008)
<7> [116.927414] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 0, found 2096)
<7> [116.927544] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 0, found 1080)
<7> [116.927679] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 0, found 1080)
<7> [116.927847] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 0, found 1084)
<7> [116.927981] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 0, found 1089)
<7> [116.928119] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 0, found 1125)
<7> [116.928250] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 0, found 1125)
<7> [116.928385] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 0, found 1920)
<7> [116.928515] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 0, found 2360)
<7> [116.928666] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 0, found 1920)
<7> [116.928813] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 0, found 2360)
<7> [116.928942] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 0, found 2008)
<7> [116.929078] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 0, found 2096)
<7> [116.929207] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 0, found 1080)
<7> [116.929344] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 0, found 1080)
<7> [116.929472] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 0, found 1084)
<7> [116.929601] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 0, found 1089)
<7> [116.929756] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 0, found 1125)
<7> [116.929907] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 0, found 1125)
<7> [116.930036] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in pixel_multiplier (expected 0, found 1)
<7> [116.930171] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 0, found 1)
<7> [116.930299] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 0, found 4)
<7> [116.930436] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in pipe_bpp (expected 0, found 24)
<7> [116.930565] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 0, found 139929)
<7> [116.930719] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 0, found 139929)
<7> [116.930869] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in port_clock (expected 0, found 139929)
<7> [116.931002] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:151:pipe A] fastset requirement not met, forcing full modeset
<7> [116.931163] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] Enabled dbuf slices 0x1 -> 0x3 (total dbuf slices 0x3), mbus joined? no->no
<7> [116.931302] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:151:pipe A] dbuf slices 0x0 -> 0x3, ddb (0 - 0) -> (0 - 2048), active pipes 0x0 -> 0x1
<7> [116.931453] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:35:plane 1A] ddb ( 0 - 0) -> ( 0 - 2016), size 0 -> 2016
<7> [116.931596] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:145:cursor A] ddb ( 0 - 0) -> (2016 - 2048), size 0 -> 32
<7> [116.931741] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] level wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm -> *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm
<7> [116.931882] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] lines 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 1, 2, 2, 2, 2, 5, 8, 9, 0, 0, 0
<7> [116.932017] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] blocks 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 16, 33, 33, 33, 33, 81, 129, 145, 30, 0, 0
<7> [116.932145] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] min_ddb 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 19, 38, 38, 38, 38, 91, 143, 161, 31, 0, 0
<7> [116.932294] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] [CRTC:151:pipe A] data rate 559716 num active planes 1
<7> [116.932428] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] QGV point 0: max bw 16761 required 560
<7> [116.932560] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] No SAGV, using single QGV point mask 0x1
<7> [116.932743] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:151:pipe A] min cdclk: 0 kHz -> 69965 kHz
<7> [116.932905] i915 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [i915]] dbuf bandwidth min cdclk: 0 kHz -> 8746 kHz
<7> [116.933049] i915 0000:00:02.0: [drm:intel_find_dpll [i915]] [CRTC:151:pipe A] allocated DPLL 0
<7> [116.933186] i915 0000:00:02.0: [drm:intel_dpll_crtc_get [i915]] [CRTC:151:pipe A] reserving DPLL 0
<7> [116.933330] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:151:pipe A] enable: yes [modeset]
<7> [116.933463] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] active: yes, output_types: HDMI (0x40), output format: RGB, sink format: RGB
<7> [116.933614] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] cpu_transcoder: A, pipe bpp: 24, dithering: 0
<7> [116.933761] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] MST master transcoder: <invalid>
<7> [116.933909] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] port sync: master transcoder: <invalid>, slave transcoder bitmask = 0x0
<7> [116.934049] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] joiner: no, pipes: 0x0
<7> [116.934179] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] splitter: disabled, link count 0, overlap 0
<7> [116.934316] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] audio: 0, infoframes: 0, infoframes enabled: 0x0
<7> [116.934445] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] scanline offset: 2
<7> [116.934610] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] framestart delay: 1, MSA timing delay: 0, set context latency: 0
<7> [116.934740] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: no, fixed rr: yes, vmin: 1125, vmax: 1125, flipline: 1125, pipeline full: 42, guardband: 44 vsync start: 0, vsync end: 0
<7> [116.934890] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: vmin vblank: 1081, vmax vblank: 1081, vmin vtotal: 1125, vmax vtotal: 1125
<7> [116.935019] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: dc balance: no, vmin: 0 vmax: 0 guardband: 0, slope: 0 max increase: 0 max decrease: 0 vblank target: 0
<7> [116.935156] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] requested mode: "1920x1080": 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5
<7> [116.935285] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] adjusted mode: "1920x1080": 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5
<7> [116.935414] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] crtc timings: clock=139929, hd=1920 hb=1920-2360 hs=2008-2096 ht=2360, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [116.935545] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe mode: "1920x1080": 53 139929 1920 2008 2096 2360 1080 1084 1089 1125 0x40 0x5
<7> [116.935708] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] crtc timings: clock=139929, hd=1920 hb=1920-2360 hs=2008-2096 ht=2360, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [116.935848] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] port clock: 139929, pipe src: 1920x1080+0+0, pixel rate 139929, min cdclk 69965
<7> [116.935987] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] linetime: 135, ips linetime: 0
<7> [116.936115] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] num_scalers: 2, scaler_users: 0x0, scaler_id: -1, scaling_filter: 0
<7> [116.936252] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pch pfit: 0x0+0+0, disabled, force thru: no
<7> [116.936380] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] ips: 0, double wide: 0, drrs: 0
<7> [116.936510] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] dpll_hw_state: cfgcr0: 0x1a6655d, cfgcr1: 0xe84, div0: 0x0, mg_refclkin_ctl: 0x0, hg_clktop2_coreclkctl1: 0x0, mg_clktop2_hsclkctl: 0x0, mg_pll_div0: 0x0, mg_pll_div2: 0x0, mg_pll_lf: 0x0, mg_pll_frac_lock: 0x0, mg_pll_ssc: 0x0, mg_pll_bias: 0x0, mg_pll_tdc_coldst_bias: 0x0
<7> [116.936666] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] csc_mode: 0x0 gamma_mode: 0x0 gamma_enable: 0 csc_enable: 0
<7> [116.936796] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pre csc lut: 0 entries, post csc lut: 0 entries
<7> [116.936996] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: pre offsets: 0x0000 0x0000 0x0000
<7> [116.937128] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [116.937265] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [116.937395] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [116.937560] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: post offsets: 0x0000 0x0000 0x0000
<7> [116.937689] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: pre offsets: 0x0000 0x0000 0x0000
<7> [116.937845] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [116.937979] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [116.938111] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [116.938242] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: post offsets: 0x0000 0x0000 0x0000
<7> [116.938370] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] sharpness strength: 0, sharpness tap size: 0, sharpness enable: 0
<7> [116.938498] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:35:plane 1A] fb: [FB:417] 1920x1080 format = XR24 little-endian (0x34325258) modifier = 0x100000000000001, visible: yes
<7> [116.938667] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] rotation: 0x1, scaler: -1, scaling_filter: 0
<7> [116.938796] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] src: 1920.000000x1080.000000+0.000000+0.000000 dst: 1920x1080+0+0
<7> [116.938950] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:65:plane 2A] fb: [NOFB], visible: no
<7> [116.939078] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:95:plane 3A] fb: [NOFB], visible: no
<7> [116.939212] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:125:plane 4A] fb: [NOFB], visible: no
<7> [116.939340] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:135:plane 5A] fb: [NOFB], visible: no
<7> [116.939468] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:145:cursor A] fb: [NOFB], visible: no
<7> [116.940135] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:389:DDI B/PHY B]
<7> [116.940277] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:399:DDI TC1/PHY C]
<7> [116.940423] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:403:DDI TC2/PHY D]
<7> [116.940571] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:405:DP-MST A]
<7> [116.940703] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:406:DP-MST B]
<7> [116.940854] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:407:DP-MST C]
<7> [116.941029] i915 0000:00:02.0: [drm:gen9_dbuf_slices_update [i915]] Updating dbuf slices to 0x3
<7> [116.941251] i915 0000:00:02.0: [drm:intel_dpll_enable [i915]] enable DPLL 0 (active 0x1, on? 0) for [CRTC:151:pipe A]
<7> [116.941414] i915 0000:00:02.0: [drm:intel_dpll_enable [i915]] enabling DPLL 0
<7> [116.941589] i915 0000:00:02.0: [drm:intel_dp_dual_mode_set_tmds_output [i915]] Enabling DP dual mode adaptor TMDS output
<7> [116.946427] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling DDI_IO_B
<7> [116.946603] i915 0000:00:02.0: [drm:intel_enable_transcoder [i915]] enabling pipe A
<7> [116.946996] i915 0000:00:02.0: [drm:intel_fbc_update [i915]] reserved 17694720 bytes of contiguous stolen space for FBC, limit: 1
<7> [116.947151] i915 0000:00:02.0: [drm:intel_fbc_update [i915]] Enabling FBC on [PLANE:35:plane 1A]
<7> [116.966197] i915 0000:00:02.0: [drm:verify_connector_state [i915]] [CONNECTOR:390:HDMI-A-1]
<7> [116.966460] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:151:pipe A]
<7> [116.985070] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling DC_off
<7> [116.985559] i915 0000:00:02.0: [drm:skl_enable_dc6 [i915]] Enabling DC6
<7> [116.986055] i915 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [i915]] Setting DC state from 00 to 02
<7> [117.291548] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling DC_off
<7> [117.292220] i915 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [i915]] Setting DC state from 02 to 00
<7> [127.307290] i915 0000:00:02.0: [drm:drm_mode_rmfb_work_fn] Removing [FB:417] from all active usage due to RMFB ioctl
<7> [127.307418] i915 0000:00:02.0: [drm:atomic_remove_fb] Disabling [PLANE:35:plane 1A] because [FB:417] is removed
<7> [127.307549] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:35:plane 1A] ddb ( 0 - 2016) -> ( 0 - 0), size 2016 -> 0
<7> [127.308346] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] level *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm -> wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm
<7> [127.308988] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] lines 1, 2, 2, 2, 2, 5, 8, 9, 0, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [127.309571] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] blocks 16, 33, 33, 33, 33, 81, 129, 145, 30, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [127.310149] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] min_ddb 19, 38, 38, 38, 38, 91, 143, 161, 31, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [127.310785] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] [CRTC:151:pipe A] data rate 0 num active planes 0
<7> [127.311355] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] QGV point 0: max bw 16761 required 0
<7> [127.325855] i915 0000:00:02.0: [drm:__intel_fbc_disable [i915]] Disabling FBC on [PLANE:35:plane 1A]
<6> [127.345327] [IGT] kms_flip: finished subtest A-HDMI-A1, SUCCESS
<6> [127.347069] [IGT] kms_flip: starting dynamic subtest B-HDMI-A1
<7> [127.348696] i915 0000:00:02.0: [drm:drm_mode_addfb2] [FB:417]
<7> [127.349302] i915 0000:00:02.0: [drm:drm_mode_addfb2] [FB:419]
<7> [127.362805] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling DC_off
<7> [127.362992] i915 0000:00:02.0: [drm:skl_enable_dc6 [i915]] Enabling DC6
<7> [127.363130] i915 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [i915]] Setting DC state from 00 to 02
<7> [127.387149] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:151:pipe A]
<7> [127.387342] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.enable (expected yes, found no)
<7> [127.387780] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.active (expected yes, found no)
<7> [127.388324] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in cpu_transcoder (expected 0, found -1)
<7> [127.388796] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in lane_count (expected 4, found 0)
<7> [127.389135] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in output_types (expected 0x00000040, found 0x00000000)
<7> [127.389473] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [127.389888] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 1920, found 0)
<7> [127.390308] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 2360, found 0)
<7> [127.390605] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 1920, found 0)
<7> [127.390934] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 2360, found 0)
<7> [127.391319] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2008, found 0)
<7> [127.391683] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2096, found 0)
<7> [127.392022] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1080, found 0)
<7> [127.392365] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1080, found 0)
<7> [127.392780] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1084, found 0)
<7> [127.393073] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1089, found 0)
<7> [127.393300] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1125, found 0)
<7> [127.393534] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1125, found 0)
<7> [127.393696] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 1920, found 0)
<7> [127.393847] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 2360, found 0)
<7> [127.393978] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 1920, found 0)
<7> [127.394108] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 2360, found 0)
<7> [127.394245] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2008, found 0)
<7> [127.394432] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2096, found 0)
<7> [127.394588] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1080, found 0)
<7> [127.394728] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1080, found 0)
<7> [127.394857] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1084, found 0)
<7> [127.394987] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1089, found 0)
<7> [127.395116] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1125, found 0)
<7> [127.395255] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1125, found 0)
<7> [127.395442] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [127.395579] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 1, found 0)
<7> [127.395707] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 4, found 0)
<7> [127.395852] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in pipe_bpp (expected 24, found 0)
<7> [127.395981] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 139929, found 0)
<7> [127.396117] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 139929, found 0)
<7> [127.396303] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in port_clock (expected 139929, found 0)
<7> [127.396440] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:151:pipe A] fastset requirement not met, forcing full modeset
<7> [127.396570] i915 0000:00:02.0: [drm:intel_dpll_crtc_put [i915]] [CRTC:151:pipe A] releasing DPLL 0
<7> [127.396735] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] Enabled dbuf slices 0x3 -> 0x1 (total dbuf slices 0x3), mbus joined? no->no
<7> [127.396868] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:151:pipe A] dbuf slices 0x3 -> 0x0, ddb (0 - 2048) -> (0 - 0), active pipes 0x1 -> 0x0
<7> [127.397053] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:145:cursor A] ddb (2016 - 2048) -> ( 0 - 0), size 32 -> 0
<7> [127.397282] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:151:pipe A] min cdclk: 69965 kHz -> 0 kHz
<7> [127.397424] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:151:pipe A] enable: no [modeset]
<7> [127.397560] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:35:plane 1A] fb: [NOFB], visible: no
<7> [127.397693] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:65:plane 2A] fb: [NOFB], visible: no
<7> [127.397844] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:95:plane 3A] fb: [NOFB], visible: no
<7> [127.397976] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:125:plane 4A] fb: [NOFB], visible: no
<7> [127.398108] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:135:plane 5A] fb: [NOFB], visible: no
<7> [127.398289] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:145:cursor A] fb: [NOFB], visible: no
<7> [127.398503] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling DC_off
<7> [127.398642] i915 0000:00:02.0: [drm:gen9_set_dc_state.part.0 [i915]] Setting DC state from 02 to 00
<7> [127.398983] i915 0000:00:02.0: [drm:intel_disable_transcoder [i915]] disabling pipe A
<7> [127.401783] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling DDI_IO_B
<7> [127.401940] i915 0000:00:02.0: [drm:intel_dp_dual_mode_set_tmds_output [i915]] Disabling DP dual mode adaptor TMDS output
<7> [127.406716] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disable DPLL 0 (active 0x1, on? 1) for [CRTC:151:pipe A]
<7> [127.406870] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disabling DPLL 0
<7> [127.407016] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:389:DDI B/PHY B]
<7> [127.407163] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:399:DDI TC1/PHY C]
<7> [127.407296] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:403:DDI TC2/PHY D]
<7> [127.407429] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:405:DP-MST A]
<7> [127.407560] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:406:DP-MST B]
<7> [127.407693] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:407:DP-MST C]
<7> [127.407846] i915 0000:00:02.0: [drm:verify_connector_state [i915]] [CONNECTOR:390:HDMI-A-1]
<7> [127.408112] i915 0000:00:02.0: [drm:gen9_dbuf_slices_update [i915]] Updating dbuf slices to 0x1
<7> [127.408301] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:151:pipe A]
<7> [127.408660] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:269:pipe B]
<7> [127.408823] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:387:pipe C]
<7> [127.409023] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:269:pipe B]
<7> [127.409057] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CONNECTOR:390:HDMI-A-1]
<7> [127.409135] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CONNECTOR:390:HDMI-A-1] Limiting target display pipe bpp to 24 (EDID bpp 24, max requested bpp 36, max platform bpp 36)
<7> [127.409280] i915 0000:00:02.0: [drm:intel_hdmi_compute_clock [i915]] picking 8 bpc for HDMI output (pipe bpp: 24)
<7> [127.409404] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:269:pipe B] hw max bpp: 24, pipe bpp: 24, dithering: 0
<7> [127.409539] i915 0000:00:02.0: [drm:intel_ddi_compute_config_late [i915]] [ENCODER:389:DDI B/PHY B] [CRTC:269:pipe B]
<7> [127.409666] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.enable (expected no, found yes)
<7> [127.409824] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.active (expected no, found yes)
<7> [127.409996] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in cpu_transcoder (expected -1, found 1)
<7> [127.410176] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in lane_count (expected 0, found 4)
<7> [127.410308] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in output_types (expected 0x00000000, found 0x00000040)
<7> [127.410439] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in framestart_delay (expected 0, found 1)
<7> [127.410570] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 0, found 1920)
<7> [127.410700] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 0, found 2360)
<7> [127.410862] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 0, found 1920)
<7> [127.411048] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 0, found 2360)
<7> [127.411183] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 0, found 2008)
<7> [127.411311] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 0, found 2096)
<7> [127.411441] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 0, found 1080)
<7> [127.411570] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 0, found 1080)
<7> [127.411699] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 0, found 1084)
<7> [127.411905] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 0, found 1089)
<7> [127.412080] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 0, found 1125)
<7> [127.412212] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 0, found 1125)
<7> [127.412341] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 0, found 1920)
<7> [127.412469] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 0, found 2360)
<7> [127.412597] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 0, found 1920)
<7> [127.412736] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 0, found 2360)
<7> [127.412896] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 0, found 2008)
<7> [127.413071] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 0, found 2096)
<7> [127.413200] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 0, found 1080)
<7> [127.413328] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 0, found 1080)
<7> [127.413456] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 0, found 1084)
<7> [127.413584] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 0, found 1089)
<7> [127.413721] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 0, found 1125)
<7> [127.413906] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 0, found 1125)
<7> [127.414062] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in pixel_multiplier (expected 0, found 1)
<7> [127.414194] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 0, found 1)
<7> [127.414326] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 0, found 4)
<7> [127.414458] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in pipe_bpp (expected 0, found 24)
<7> [127.414588] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 0, found 139929)
<7> [127.414774] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 0, found 139929)
<7> [127.414957] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in port_clock (expected 0, found 139929)
<7> [127.415093] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:269:pipe B] fastset requirement not met, forcing full modeset
<7> [127.415241] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] Enabled dbuf slices 0x1 -> 0x3 (total dbuf slices 0x3), mbus joined? no->no
<7> [127.415371] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:269:pipe B] dbuf slices 0x0 -> 0x3, ddb (0 - 0) -> (0 - 2048), active pipes 0x0 -> 0x2
<7> [127.415521] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:153:plane 1B] ddb ( 0 - 0) -> ( 0 - 2016), size 0 -> 2016
<7> [127.415649] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:263:cursor B] ddb ( 0 - 0) -> (2016 - 2048), size 0 -> 32
<7> [127.415827] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] level wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm -> *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm
<7> [127.416000] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] lines 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 1, 2, 2, 2, 2, 5, 8, 9, 0, 0, 0
<7> [127.416131] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] blocks 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 16, 33, 33, 33, 33, 81, 129, 145, 30, 0, 0
<7> [127.416260] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] min_ddb 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 19, 38, 38, 38, 38, 91, 143, 161, 31, 0, 0
<7> [127.416401] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] [CRTC:269:pipe B] data rate 559716 num active planes 1
<7> [127.416536] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] QGV point 0: max bw 16761 required 560
<7> [127.416694] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] No SAGV, using single QGV point mask 0x1
<7> [127.416900] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:269:pipe B] min cdclk: 0 kHz -> 69965 kHz
<7> [127.417046] i915 0000:00:02.0: [drm:intel_find_dpll [i915]] [CRTC:269:pipe B] allocated DPLL 0
<7> [127.417181] i915 0000:00:02.0: [drm:intel_dpll_crtc_get [i915]] [CRTC:269:pipe B] reserving DPLL 0
<7> [127.417317] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:269:pipe B] enable: yes [modeset]
<7> [127.417449] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] active: yes, output_types: HDMI (0x40), output format: RGB, sink format: RGB
<7> [127.417624] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] cpu_transcoder: B, pipe bpp: 24, dithering: 0
<7> [127.417819] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] MST master transcoder: <invalid>
<7> [127.417957] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] port sync: master transcoder: <invalid>, slave transcoder bitmask = 0x0
<7> [127.418089] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] joiner: no, pipes: 0x0
<7> [127.418220] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] splitter: disabled, link count 0, overlap 0
<7> [127.418349] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] audio: 0, infoframes: 0, infoframes enabled: 0x0
<7> [127.418482] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] scanline offset: 2
<7> [127.418671] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] framestart delay: 1, MSA timing delay: 0, set context latency: 0
<7> [127.418873] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: no, fixed rr: yes, vmin: 1125, vmax: 1125, flipline: 1125, pipeline full: 42, guardband: 44 vsync start: 0, vsync end: 0
<7> [127.419003] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: vmin vblank: 1081, vmax vblank: 1081, vmin vtotal: 1125, vmax vtotal: 1125
<7> [127.419132] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: dc balance: no, vmin: 0 vmax: 0 guardband: 0, slope: 0 max increase: 0 max decrease: 0 vblank target: 0
<7> [127.419261] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] requested mode: "1920x1080": 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5
<7> [127.419410] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] adjusted mode: "1920x1080": 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5
<7> [127.419598] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] crtc timings: clock=139929, hd=1920 hb=1920-2360 hs=2008-2096 ht=2360, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [127.419750] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe mode: "1920x1080": 53 139929 1920 2008 2096 2360 1080 1084 1089 1125 0x40 0x5
<7> [127.419884] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] crtc timings: clock=139929, hd=1920 hb=1920-2360 hs=2008-2096 ht=2360, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [127.420013] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] port clock: 139929, pipe src: 1920x1080+0+0, pixel rate 139929, min cdclk 69965
<7> [127.420141] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] linetime: 135, ips linetime: 0
<7> [127.420303] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] num_scalers: 2, scaler_users: 0x0, scaler_id: -1, scaling_filter: 0
<7> [127.420474] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pch pfit: 0x0+0+0, disabled, force thru: no
<7> [127.420602] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] ips: 0, double wide: 0, drrs: 0
<7> [127.420738] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] dpll_hw_state: cfgcr0: 0x1a6655d, cfgcr1: 0xe84, div0: 0x0, mg_refclkin_ctl: 0x0, hg_clktop2_coreclkctl1: 0x0, mg_clktop2_hsclkctl: 0x0, mg_pll_div0: 0x0, mg_pll_div2: 0x0, mg_pll_lf: 0x0, mg_pll_frac_lock: 0x0, mg_pll_ssc: 0x0, mg_pll_bias: 0x0, mg_pll_tdc_coldst_bias: 0x0
<7> [127.420870] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] csc_mode: 0x0 gamma_mode: 0x0 gamma_enable: 0 csc_enable: 0
<7> [127.421003] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pre csc lut: 0 entries, post csc lut: 0 entries
<7> [127.421181] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: pre offsets: 0x0000 0x0000 0x0000
<7> [127.421356] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [127.421491] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [127.421621] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [127.421762] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: post offsets: 0x0000 0x0000 0x0000
<7> [127.421892] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: pre offsets: 0x0000 0x0000 0x0000
<7> [127.422021] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [127.422210] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [127.422355] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [127.422483] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: post offsets: 0x0000 0x0000 0x0000
<7> [127.422611] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] sharpness strength: 0, sharpness tap size: 0, sharpness enable: 0
<7> [127.422750] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:153:plane 1B] fb: [FB:417] 1920x1080 format = XR24 little-endian (0x34325258) modifier = 0x100000000000001, visible: yes
<7> [127.422880] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] rotation: 0x1, scaler: -1, scaling_filter: 0
<7> [127.423051] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] src: 1920.000000x1080.000000+0.000000+0.000000 dst: 1920x1080+0+0
<7> [127.423219] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:183:plane 2B] fb: [NOFB], visible: no
<7> [127.423348] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:213:plane 3B] fb: [NOFB], visible: no
<7> [127.423476] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:243:plane 4B] fb: [NOFB], visible: no
<7> [127.423604] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:253:plane 5B] fb: [NOFB], visible: no
<7> [127.423751] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:263:cursor B] fb: [NOFB], visible: no
<7> [127.424496] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling PW_3
<7> [127.424659] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:389:DDI B/PHY B]
<7> [127.424810] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:399:DDI TC1/PHY C]
<7> [127.424951] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:403:DDI TC2/PHY D]
<7> [127.425138] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:405:DP-MST A]
<7> [127.425272] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:406:DP-MST B]
<7> [127.425403] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:407:DP-MST C]
<7> [127.425570] i915 0000:00:02.0: [drm:gen9_dbuf_slices_update [i915]] Updating dbuf slices to 0x3
<7> [127.425744] i915 0000:00:02.0: [drm:intel_dpll_enable [i915]] enable DPLL 0 (active 0x2, on? 0) for [CRTC:269:pipe B]
<7> [127.425917] i915 0000:00:02.0: [drm:intel_dpll_enable [i915]] enabling DPLL 0
<7> [127.426129] i915 0000:00:02.0: [drm:intel_dp_dual_mode_set_tmds_output [i915]] Enabling DP dual mode adaptor TMDS output
<7> [127.430965] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling DDI_IO_B
<7> [127.431140] i915 0000:00:02.0: [drm:intel_enable_transcoder [i915]] enabling pipe B
<7> [127.451336] i915 0000:00:02.0: [drm:verify_connector_state [i915]] [CONNECTOR:390:HDMI-A-1]
<7> [127.451630] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:269:pipe B]
<7> [140.969122] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:151:pipe A]
<7> [140.969880] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:269:pipe B]
<7> [140.970253] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.enable (expected yes, found no)
<7> [140.970995] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.active (expected yes, found no)
<7> [140.971638] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in cpu_transcoder (expected 1, found -1)
<7> [140.972206] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in lane_count (expected 4, found 0)
<7> [140.972809] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in output_types (expected 0x00000040, found 0x00000000)
<7> [140.973365] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [140.973979] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 1920, found 0)
<7> [140.974530] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 2360, found 0)
<7> [140.974677] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 1920, found 0)
<7> [140.974806] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 2360, found 0)
<7> [140.974935] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2008, found 0)
<7> [140.975066] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2096, found 0)
<7> [140.975195] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1080, found 0)
<7> [140.975325] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1080, found 0)
<7> [140.975454] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1084, found 0)
<7> [140.975582] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1089, found 0)
<7> [140.975723] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1125, found 0)
<7> [140.975852] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1125, found 0)
<7> [140.975982] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 1920, found 0)
<7> [140.976111] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 2360, found 0)
<7> [140.976240] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 1920, found 0)
<7> [140.976369] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 2360, found 0)
<7> [140.976498] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2008, found 0)
<7> [140.976627] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2096, found 0)
<7> [140.976771] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1080, found 0)
<7> [140.976905] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1080, found 0)
<7> [140.977039] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1084, found 0)
<7> [140.977172] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1089, found 0)
<7> [140.977303] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1125, found 0)
<7> [140.977434] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1125, found 0)
<7> [140.977563] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [140.977708] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 1, found 0)
<7> [140.977837] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 4, found 0)
<7> [140.977968] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in pipe_bpp (expected 24, found 0)
<7> [140.978098] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 139929, found 0)
<7> [140.978227] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 139929, found 0)
<7> [140.978355] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in port_clock (expected 139929, found 0)
<7> [140.978484] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:269:pipe B] fastset requirement not met, forcing full modeset
<7> [140.978613] i915 0000:00:02.0: [drm:intel_dpll_crtc_put [i915]] [CRTC:269:pipe B] releasing DPLL 0
<7> [140.978784] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] Enabled dbuf slices 0x3 -> 0x1 (total dbuf slices 0x3), mbus joined? no->no
<7> [140.978914] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:269:pipe B] dbuf slices 0x3 -> 0x0, ddb (0 - 2048) -> (0 - 0), active pipes 0x2 -> 0x0
<7> [140.979064] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:153:plane 1B] ddb ( 0 - 2016) -> ( 0 - 0), size 2016 -> 0
<7> [140.979193] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:263:cursor B] ddb (2016 - 2048) -> ( 0 - 0), size 32 -> 0
<7> [140.979320] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] level *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm -> wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm
<7> [140.979447] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] lines 1, 2, 2, 2, 2, 5, 8, 9, 0, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [140.979575] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] blocks 16, 33, 33, 33, 33, 81, 129, 145, 30, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [140.979712] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] min_ddb 19, 38, 38, 38, 38, 91, 143, 161, 31, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [140.979855] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] [CRTC:269:pipe B] data rate 0 num active planes 0
<7> [140.979987] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] QGV point 0: max bw 16761 required 0
<7> [140.980132] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:269:pipe B] min cdclk: 69965 kHz -> 0 kHz
<7> [140.980279] i915 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [i915]] dbuf bandwidth min cdclk: 8746 kHz -> 0 kHz
<7> [140.980412] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:269:pipe B] enable: no [modeset]
<7> [140.980544] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:153:plane 1B] fb: [NOFB], visible: no
<7> [140.980674] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:183:plane 2B] fb: [NOFB], visible: no
<7> [140.980821] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:213:plane 3B] fb: [NOFB], visible: no
<7> [140.980955] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:243:plane 4B] fb: [NOFB], visible: no
<7> [140.981086] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:253:plane 5B] fb: [NOFB], visible: no
<7> [140.981216] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:263:cursor B] fb: [NOFB], visible: no
<7> [140.981448] i915 0000:00:02.0: [drm:intel_disable_transcoder [i915]] disabling pipe B
<7> [141.000086] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling DDI_IO_B
<7> [141.000402] i915 0000:00:02.0: [drm:intel_dp_dual_mode_set_tmds_output [i915]] Disabling DP dual mode adaptor TMDS output
<7> [141.005395] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disable DPLL 0 (active 0x2, on? 1) for [CRTC:269:pipe B]
<7> [141.005968] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disabling DPLL 0
<7> [141.006529] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:389:DDI B/PHY B]
<7> [141.006944] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:399:DDI TC1/PHY C]
<7> [141.007307] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:403:DDI TC2/PHY D]
<7> [141.007626] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:405:DP-MST A]
<7> [141.007946] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:406:DP-MST B]
<7> [141.008443] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:407:DP-MST C]
<7> [141.008783] i915 0000:00:02.0: [drm:verify_connector_state [i915]] [CONNECTOR:390:HDMI-A-1]
<7> [141.009199] i915 0000:00:02.0: [drm:gen9_dbuf_slices_update [i915]] Updating dbuf slices to 0x1
<7> [141.009606] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling PW_3
<7> [141.009916] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:269:pipe B]
<7> [141.010578] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:387:pipe C]
<7> [141.010929] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:269:pipe B]
<7> [141.010967] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CONNECTOR:390:HDMI-A-1]
<7> [141.011085] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CONNECTOR:390:HDMI-A-1] Limiting target display pipe bpp to 24 (EDID bpp 24, max requested bpp 36, max platform bpp 36)
<7> [141.011344] i915 0000:00:02.0: [drm:intel_hdmi_compute_clock [i915]] picking 8 bpc for HDMI output (pipe bpp: 24)
<7> [141.011574] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:269:pipe B] hw max bpp: 24, pipe bpp: 24, dithering: 0
<7> [141.011876] i915 0000:00:02.0: [drm:intel_ddi_compute_config_late [i915]] [ENCODER:389:DDI B/PHY B] [CRTC:269:pipe B]
<7> [141.012125] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.enable (expected no, found yes)
<7> [141.012310] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.active (expected no, found yes)
<7> [141.012495] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in cpu_transcoder (expected -1, found 1)
<7> [141.012682] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in lane_count (expected 0, found 4)
<7> [141.012926] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in output_types (expected 0x00000000, found 0x00000040)
<7> [141.013170] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in framestart_delay (expected 0, found 1)
<7> [141.013355] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 0, found 1920)
<7> [141.013538] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 0, found 2360)
<7> [141.013720] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 0, found 1920)
<7> [141.013982] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 0, found 2360)
<7> [141.014201] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 0, found 2008)
<7> [141.014381] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 0, found 2096)
<7> [141.014561] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 0, found 1080)
<7> [141.014763] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 0, found 1080)
<7> [141.015017] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 0, found 1084)
<7> [141.015201] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 0, found 1089)
<7> [141.015330] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 0, found 1125)
<7> [141.015460] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 0, found 1125)
<7> [141.015589] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 0, found 1920)
<7> [141.015717] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 0, found 2360)
<7> [141.015853] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 0, found 1920)
<7> [141.016041] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 0, found 2360)
<7> [141.016202] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 0, found 2008)
<7> [141.016334] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 0, found 2096)
<7> [141.016464] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 0, found 1080)
<7> [141.016594] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 0, found 1080)
<7> [141.016735] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 0, found 1084)
<7> [141.016921] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 0, found 1089)
<7> [141.017058] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 0, found 1125)
<7> [141.017204] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 0, found 1125)
<7> [141.017332] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in pixel_multiplier (expected 0, found 1)
<7> [141.017462] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 0, found 1)
<7> [141.017614] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 0, found 4)
<7> [141.017802] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in pipe_bpp (expected 0, found 24)
<7> [141.017954] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 0, found 139929)
<7> [141.018081] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 0, found 139929)
<7> [141.018263] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in port_clock (expected 0, found 139929)
<7> [141.018391] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:269:pipe B] fastset requirement not met, forcing full modeset
<7> [141.018540] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] Enabled dbuf slices 0x1 -> 0x3 (total dbuf slices 0x3), mbus joined? no->no
<7> [141.018703] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:269:pipe B] dbuf slices 0x0 -> 0x3, ddb (0 - 0) -> (0 - 2048), active pipes 0x0 -> 0x2
<7> [141.018905] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:153:plane 1B] ddb ( 0 - 0) -> ( 0 - 2016), size 0 -> 2016
<7> [141.019033] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:263:cursor B] ddb ( 0 - 0) -> (2016 - 2048), size 0 -> 32
<7> [141.019175] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] level wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm -> *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm
<7> [141.019305] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] lines 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 1, 2, 2, 2, 2, 5, 8, 9, 0, 0, 0
<7> [141.019435] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] blocks 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 16, 33, 33, 33, 33, 81, 129, 145, 30, 0, 0
<7> [141.019597] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] min_ddb 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 19, 38, 38, 38, 38, 91, 143, 161, 31, 0, 0
<7> [141.019782] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] [CRTC:269:pipe B] data rate 559716 num active planes 1
<7> [141.019915] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] QGV point 0: max bw 16761 required 560
<7> [141.020046] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] No SAGV, using single QGV point mask 0x1
<7> [141.020204] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:269:pipe B] min cdclk: 0 kHz -> 69965 kHz
<7> [141.020349] i915 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [i915]] dbuf bandwidth min cdclk: 0 kHz -> 8746 kHz
<7> [141.020536] i915 0000:00:02.0: [drm:intel_find_dpll [i915]] [CRTC:269:pipe B] allocated DPLL 0
<7> [141.020688] i915 0000:00:02.0: [drm:intel_dpll_crtc_get [i915]] [CRTC:269:pipe B] reserving DPLL 0
<7> [141.020824] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:269:pipe B] enable: yes [modeset]
<7> [141.020957] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] active: yes, output_types: HDMI (0x40), output format: RGB, sink format: RGB
<7> [141.021088] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] cpu_transcoder: B, pipe bpp: 24, dithering: 0
<7> [141.021259] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] MST master transcoder: <invalid>
<7> [141.021451] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] port sync: master transcoder: <invalid>, slave transcoder bitmask = 0x0
<7> [141.021608] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] joiner: no, pipes: 0x0
<7> [141.021741] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] splitter: disabled, link count 0, overlap 0
<7> [141.021872] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] audio: 0, infoframes: 0, infoframes enabled: 0x0
<7> [141.022002] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] scanline offset: 2
<7> [141.022131] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] framestart delay: 1, MSA timing delay: 0, set context latency: 0
<7> [141.022284] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: no, fixed rr: yes, vmin: 1125, vmax: 1125, flipline: 1125, pipeline full: 42, guardband: 44 vsync start: 0, vsync end: 0
<7> [141.022473] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: vmin vblank: 1081, vmax vblank: 1081, vmin vtotal: 1125, vmax vtotal: 1125
<7> [141.022619] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: dc balance: no, vmin: 0 vmax: 0 guardband: 0, slope: 0 max increase: 0 max decrease: 0 vblank target: 0
<7> [141.022747] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] requested mode: "1920x1080": 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5
<7> [141.022876] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] adjusted mode: "1920x1080": 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5
<7> [141.023005] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] crtc timings: clock=139929, hd=1920 hb=1920-2360 hs=2008-2096 ht=2360, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [141.023134] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe mode: "1920x1080": 53 139929 1920 2008 2096 2360 1080 1084 1089 1125 0x40 0x5
<7> [141.023336] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] crtc timings: clock=139929, hd=1920 hb=1920-2360 hs=2008-2096 ht=2360, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [141.023506] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] port clock: 139929, pipe src: 1920x1080+0+0, pixel rate 139929, min cdclk 69965
<7> [141.023635] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] linetime: 135, ips linetime: 0
<7> [141.023763] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] num_scalers: 2, scaler_users: 0x0, scaler_id: -1, scaling_filter: 0
<7> [141.023891] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pch pfit: 0x0+0+0, disabled, force thru: no
<7> [141.024020] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] ips: 0, double wide: 0, drrs: 0
<7> [141.024167] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] dpll_hw_state: cfgcr0: 0x1a6655d, cfgcr1: 0xe84, div0: 0x0, mg_refclkin_ctl: 0x0, hg_clktop2_coreclkctl1: 0x0, mg_clktop2_hsclkctl: 0x0, mg_pll_div0: 0x0, mg_pll_div2: 0x0, mg_pll_lf: 0x0, mg_pll_frac_lock: 0x0, mg_pll_ssc: 0x0, mg_pll_bias: 0x0, mg_pll_tdc_coldst_bias: 0x0
<7> [141.024376] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] csc_mode: 0x0 gamma_mode: 0x0 gamma_enable: 0 csc_enable: 0
<7> [141.024529] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pre csc lut: 0 entries, post csc lut: 0 entries
<7> [141.024661] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: pre offsets: 0x0000 0x0000 0x0000
<7> [141.024792] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [141.024922] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [141.025051] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [141.025192] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: post offsets: 0x0000 0x0000 0x0000
<7> [141.025381] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: pre offsets: 0x0000 0x0000 0x0000
<7> [141.025526] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [141.025654] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [141.025782] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [141.025910] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: post offsets: 0x0000 0x0000 0x0000
<7> [141.026037] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] sharpness strength: 0, sharpness tap size: 0, sharpness enable: 0
<7> [141.026214] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:153:plane 1B] fb: [FB:417] 1920x1080 format = XR24 little-endian (0x34325258) modifier = 0x100000000000001, visible: yes
<7> [141.026390] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] rotation: 0x1, scaler: -1, scaling_filter: 0
<7> [141.026518] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] src: 1920.000000x1080.000000+0.000000+0.000000 dst: 1920x1080+0+0
<7> [141.026646] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:183:plane 2B] fb: [NOFB], visible: no
<7> [141.026775] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:213:plane 3B] fb: [NOFB], visible: no
<7> [141.026902] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:243:plane 4B] fb: [NOFB], visible: no
<7> [141.027039] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:253:plane 5B] fb: [NOFB], visible: no
<7> [141.027240] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:263:cursor B] fb: [NOFB], visible: no
<7> [141.027476] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling PW_3
<7> [141.027636] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:389:DDI B/PHY B]
<7> [141.027770] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:399:DDI TC1/PHY C]
<7> [141.027904] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:403:DDI TC2/PHY D]
<7> [141.028036] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:405:DP-MST A]
<7> [141.028167] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:406:DP-MST B]
<7> [141.028315] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:407:DP-MST C]
<7> [141.028482] i915 0000:00:02.0: [drm:gen9_dbuf_slices_update [i915]] Updating dbuf slices to 0x3
<7> [141.028647] i915 0000:00:02.0: [drm:intel_dpll_enable [i915]] enable DPLL 0 (active 0x2, on? 0) for [CRTC:269:pipe B]
<7> [141.028781] i915 0000:00:02.0: [drm:intel_dpll_enable [i915]] enabling DPLL 0
<7> [141.028957] i915 0000:00:02.0: [drm:intel_dp_dual_mode_set_tmds_output [i915]] Enabling DP dual mode adaptor TMDS output
<7> [141.033774] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling DDI_IO_B
<7> [141.033949] i915 0000:00:02.0: [drm:intel_enable_transcoder [i915]] enabling pipe B
<7> [141.054205] i915 0000:00:02.0: [drm:verify_connector_state [i915]] [CONNECTOR:390:HDMI-A-1]
<7> [141.054466] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:269:pipe B]
<6> [151.658312] [IGT] kms_flip: finished subtest B-HDMI-A1, FAIL
<6> [151.658681] [IGT] kms_flip: starting dynamic subtest C-HDMI-A1
<7> [151.658977] i915 0000:00:02.0: [drm:drm_mode_addfb2] [FB:420]
<7> [151.659062] i915 0000:00:02.0: [drm:drm_mode_addfb2] [FB:421]
<7> [151.694354] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:151:pipe A]
<7> [151.694485] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:269:pipe B]
<7> [151.694544] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.enable (expected yes, found no)
<7> [151.694721] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.active (expected yes, found no)
<7> [151.694858] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in cpu_transcoder (expected 1, found -1)
<7> [151.694993] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in lane_count (expected 4, found 0)
<7> [151.695125] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in output_types (expected 0x00000040, found 0x00000000)
<7> [151.695257] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [151.695401] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 1920, found 0)
<7> [151.695533] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 2360, found 0)
<7> [151.695663] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 1920, found 0)
<7> [151.695792] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 2360, found 0)
<7> [151.695922] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2008, found 0)
<7> [151.696051] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2096, found 0)
<7> [151.696180] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1080, found 0)
<7> [151.696314] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1080, found 0)
<7> [151.696444] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1084, found 0)
<7> [151.696573] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1089, found 0)
<7> [151.696702] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1125, found 0)
<7> [151.696831] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1125, found 0)
<7> [151.696960] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 1920, found 0)
<7> [151.697089] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 2360, found 0)
<7> [151.697218] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 1920, found 0)
<7> [151.697353] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 2360, found 0)
<7> [151.697482] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2008, found 0)
<7> [151.697609] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2096, found 0)
<7> [151.697737] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1080, found 0)
<7> [151.697865] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1080, found 0)
<7> [151.697991] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1084, found 0)
<7> [151.698120] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1089, found 0)
<7> [151.698248] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1125, found 0)
<7> [151.698424] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1125, found 0)
<7> [151.698553] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [151.698681] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 1, found 0)
<7> [151.698809] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 4, found 0)
<7> [151.698940] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in pipe_bpp (expected 24, found 0)
<7> [151.699069] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 139929, found 0)
<7> [151.699198] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 139929, found 0)
<7> [151.699331] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:269:pipe B] fastset requirement not met in port_clock (expected 139929, found 0)
<7> [151.699460] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:269:pipe B] fastset requirement not met, forcing full modeset
<7> [151.699591] i915 0000:00:02.0: [drm:intel_dpll_crtc_put [i915]] [CRTC:269:pipe B] releasing DPLL 0
<7> [151.699739] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] Enabled dbuf slices 0x3 -> 0x1 (total dbuf slices 0x3), mbus joined? no->no
<7> [151.699869] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:269:pipe B] dbuf slices 0x3 -> 0x0, ddb (0 - 2048) -> (0 - 0), active pipes 0x2 -> 0x0
<7> [151.700018] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:153:plane 1B] ddb ( 0 - 2016) -> ( 0 - 0), size 2016 -> 0
<7> [151.700148] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:263:cursor B] ddb (2016 - 2048) -> ( 0 - 0), size 32 -> 0
<7> [151.700277] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] level *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm -> wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm
<7> [151.700413] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] lines 1, 2, 2, 2, 2, 5, 8, 9, 0, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [151.700541] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] blocks 16, 33, 33, 33, 33, 81, 129, 145, 30, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [151.700671] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:153:plane 1B] min_ddb 19, 38, 38, 38, 38, 91, 143, 161, 31, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [151.700814] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] [CRTC:269:pipe B] data rate 0 num active planes 0
<7> [151.700950] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] QGV point 0: max bw 16761 required 0
<7> [151.701096] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:269:pipe B] min cdclk: 69965 kHz -> 0 kHz
<7> [151.701244] i915 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [i915]] dbuf bandwidth min cdclk: 8746 kHz -> 0 kHz
<7> [151.701389] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:269:pipe B] enable: no [modeset]
<7> [151.701521] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:153:plane 1B] fb: [NOFB], visible: no
<7> [151.701653] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:183:plane 2B] fb: [NOFB], visible: no
<7> [151.701784] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:213:plane 3B] fb: [NOFB], visible: no
<7> [151.701914] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:243:plane 4B] fb: [NOFB], visible: no
<7> [151.702044] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:253:plane 5B] fb: [NOFB], visible: no
<7> [151.702173] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:263:cursor B] fb: [NOFB], visible: no
<7> [151.702396] i915 0000:00:02.0: [drm:intel_disable_transcoder [i915]] disabling pipe B
<7> [151.717441] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling DDI_IO_B
<7> [151.717603] i915 0000:00:02.0: [drm:intel_dp_dual_mode_set_tmds_output [i915]] Disabling DP dual mode adaptor TMDS output
<7> [151.722371] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disable DPLL 0 (active 0x2, on? 1) for [CRTC:269:pipe B]
<7> [151.722538] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disabling DPLL 0
<7> [151.722683] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:389:DDI B/PHY B]
<7> [151.722830] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:399:DDI TC1/PHY C]
<7> [151.722962] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:403:DDI TC2/PHY D]
<7> [151.723094] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:405:DP-MST A]
<7> [151.723225] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:406:DP-MST B]
<7> [151.723355] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:407:DP-MST C]
<7> [151.723497] i915 0000:00:02.0: [drm:verify_connector_state [i915]] [CONNECTOR:390:HDMI-A-1]
<7> [151.723693] i915 0000:00:02.0: [drm:gen9_dbuf_slices_update [i915]] Updating dbuf slices to 0x1
<7> [151.723866] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling PW_3
<7> [151.724030] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:269:pipe B]
<7> [151.724338] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:387:pipe C]
<7> [151.724472] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CRTC:387:pipe C]
<7> [151.724492] i915 0000:00:02.0: [drm:drm_mode_setcrtc] [CONNECTOR:390:HDMI-A-1]
<7> [151.724548] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CONNECTOR:390:HDMI-A-1] Limiting target display pipe bpp to 24 (EDID bpp 24, max requested bpp 36, max platform bpp 36)
<7> [151.724687] i915 0000:00:02.0: [drm:intel_hdmi_compute_clock [i915]] picking 8 bpc for HDMI output (pipe bpp: 24)
<7> [151.724811] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:387:pipe C] hw max bpp: 24, pipe bpp: 24, dithering: 0
<7> [151.724944] i915 0000:00:02.0: [drm:intel_ddi_compute_config_late [i915]] [ENCODER:389:DDI B/PHY B] [CRTC:387:pipe C]
<7> [151.725071] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.enable (expected no, found yes)
<7> [151.725204] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.active (expected no, found yes)
<7> [151.725336] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in cpu_transcoder (expected -1, found 2)
<7> [151.725479] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in lane_count (expected 0, found 4)
<7> [151.725613] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in output_types (expected 0x00000000, found 0x00000040)
<7> [151.725746] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in framestart_delay (expected 0, found 1)
<7> [151.725877] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 0, found 1920)
<7> [151.726008] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 0, found 2360)
<7> [151.726139] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 0, found 1920)
<7> [151.726268] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 0, found 2360)
<7> [151.726401] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 0, found 2008)
<7> [151.726529] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 0, found 2096)
<7> [151.726658] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 0, found 1080)
<7> [151.726787] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 0, found 1080)
<7> [151.726915] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 0, found 1084)
<7> [151.727043] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 0, found 1089)
<7> [151.727172] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 0, found 1125)
<7> [151.727299] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 0, found 1125)
<7> [151.727435] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 0, found 1920)
<7> [151.727563] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 0, found 2360)
<7> [151.727693] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 0, found 1920)
<7> [151.727820] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 0, found 2360)
<7> [151.727947] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 0, found 2008)
<7> [151.728074] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 0, found 2096)
<7> [151.728201] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 0, found 1080)
<7> [151.728329] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 0, found 1080)
<7> [151.728465] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 0, found 1084)
<7> [151.728593] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 0, found 1089)
<7> [151.728721] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 0, found 1125)
<7> [151.728849] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 0, found 1125)
<7> [151.728976] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in pixel_multiplier (expected 0, found 1)
<7> [151.729103] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 0, found 1)
<7> [151.729231] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 0, found 4)
<7> [151.729359] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in pipe_bpp (expected 0, found 24)
<7> [151.729495] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 0, found 139929)
<7> [151.729623] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 0, found 139929)
<7> [151.729751] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in port_clock (expected 0, found 139929)
<7> [151.729879] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:387:pipe C] fastset requirement not met, forcing full modeset
<7> [151.730025] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] Enabled dbuf slices 0x1 -> 0x3 (total dbuf slices 0x3), mbus joined? no->no
<7> [151.730154] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:387:pipe C] dbuf slices 0x0 -> 0x3, ddb (0 - 0) -> (0 - 2048), active pipes 0x0 -> 0x4
<7> [151.730304] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:271:plane 1C] ddb ( 0 - 0) -> ( 0 - 2016), size 0 -> 2016
<7> [151.730439] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:381:cursor C] ddb ( 0 - 0) -> (2016 - 2048), size 0 -> 32
<7> [151.730566] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:271:plane 1C] level wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm -> *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm
<7> [151.730693] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:271:plane 1C] lines 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 1, 2, 2, 2, 2, 5, 8, 9, 0, 0, 0
<7> [151.730820] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:271:plane 1C] blocks 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 16, 33, 33, 33, 33, 81, 129, 145, 30, 0, 0
<7> [151.730947] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:271:plane 1C] min_ddb 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 19, 38, 38, 38, 38, 91, 143, 161, 31, 0, 0
<7> [151.731086] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] [CRTC:387:pipe C] data rate 559716 num active planes 1
<7> [151.731221] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] QGV point 0: max bw 16761 required 560
<7> [151.731353] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] No SAGV, using single QGV point mask 0x1
<7> [151.731505] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:387:pipe C] min cdclk: 0 kHz -> 69965 kHz
<7> [151.731648] i915 0000:00:02.0: [drm:intel_cdclk_update_dbuf_bw_min_cdclk [i915]] dbuf bandwidth min cdclk: 0 kHz -> 8746 kHz
<7> [151.731779] i915 0000:00:02.0: [drm:intel_find_dpll [i915]] [CRTC:387:pipe C] allocated DPLL 0
<7> [151.731915] i915 0000:00:02.0: [drm:intel_dpll_crtc_get [i915]] [CRTC:387:pipe C] reserving DPLL 0
<7> [151.732049] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:387:pipe C] enable: yes [modeset]
<7> [151.732181] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] active: yes, output_types: HDMI (0x40), output format: RGB, sink format: RGB
<7> [151.732313] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] cpu_transcoder: C, pipe bpp: 24, dithering: 0
<7> [151.732450] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] MST master transcoder: <invalid>
<7> [151.732579] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] port sync: master transcoder: <invalid>, slave transcoder bitmask = 0x0
<7> [151.732709] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] joiner: no, pipes: 0x0
<7> [151.732838] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] splitter: disabled, link count 0, overlap 0
<7> [151.732968] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] audio: 0, infoframes: 0, infoframes enabled: 0x0
<7> [151.733096] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] scanline offset: 2
<7> [151.733224] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] framestart delay: 1, MSA timing delay: 0, set context latency: 0
<7> [151.733352] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: no, fixed rr: yes, vmin: 1125, vmax: 1125, flipline: 1125, pipeline full: 42, guardband: 44 vsync start: 0, vsync end: 0
<7> [151.733489] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: vmin vblank: 1081, vmax vblank: 1081, vmin vtotal: 1125, vmax vtotal: 1125
<7> [151.733616] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: dc balance: no, vmin: 0 vmax: 0 guardband: 0, slope: 0 max increase: 0 max decrease: 0 vblank target: 0
<7> [151.733743] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] requested mode: "1920x1080": 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5
<7> [151.733872] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] adjusted mode: "1920x1080": 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5
<7> [151.733999] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] crtc timings: clock=139929, hd=1920 hb=1920-2360 hs=2008-2096 ht=2360, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [151.734128] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe mode: "1920x1080": 53 139929 1920 2008 2096 2360 1080 1084 1089 1125 0x40 0x5
<7> [151.734257] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] crtc timings: clock=139929, hd=1920 hb=1920-2360 hs=2008-2096 ht=2360, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [151.734385] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] port clock: 139929, pipe src: 1920x1080+0+0, pixel rate 139929, min cdclk 69965
<7> [151.734531] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] linetime: 135, ips linetime: 0
<7> [151.734658] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] num_scalers: 2, scaler_users: 0x0, scaler_id: -1, scaling_filter: 0
<7> [151.734785] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pch pfit: 0x0+0+0, disabled, force thru: no
<7> [151.734912] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] ips: 0, double wide: 0, drrs: 0
<7> [151.735039] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] dpll_hw_state: cfgcr0: 0x1a6655d, cfgcr1: 0xe84, div0: 0x0, mg_refclkin_ctl: 0x0, hg_clktop2_coreclkctl1: 0x0, mg_clktop2_hsclkctl: 0x0, mg_pll_div0: 0x0, mg_pll_div2: 0x0, mg_pll_lf: 0x0, mg_pll_frac_lock: 0x0, mg_pll_ssc: 0x0, mg_pll_bias: 0x0, mg_pll_tdc_coldst_bias: 0x0
<7> [151.735168] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] csc_mode: 0x0 gamma_mode: 0x0 gamma_enable: 0 csc_enable: 0
<7> [151.735296] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pre csc lut: 0 entries, post csc lut: 0 entries
<7> [151.735429] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: pre offsets: 0x0000 0x0000 0x0000
<7> [151.735557] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [151.735685] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [151.735813] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [151.735940] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: post offsets: 0x0000 0x0000 0x0000
<7> [151.736068] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: pre offsets: 0x0000 0x0000 0x0000
<7> [151.736195] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [151.736322] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [151.736455] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [151.736582] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: post offsets: 0x0000 0x0000 0x0000
<7> [151.736710] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] sharpness strength: 0, sharpness tap size: 0, sharpness enable: 0
<7> [151.736837] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:271:plane 1C] fb: [FB:420] 1920x1080 format = XR24 little-endian (0x34325258) modifier = 0x100000000000001, visible: yes
<7> [151.736965] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] rotation: 0x1, scaler: -1, scaling_filter: 0
<7> [151.737092] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] src: 1920.000000x1080.000000+0.000000+0.000000 dst: 1920x1080+0+0
<7> [151.737219] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:301:plane 2C] fb: [NOFB], visible: no
<7> [151.737346] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:331:plane 3C] fb: [NOFB], visible: no
<7> [151.737480] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:361:plane 4C] fb: [NOFB], visible: no
<7> [151.737607] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:371:plane 5C] fb: [NOFB], visible: no
<7> [151.737733] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:381:cursor C] fb: [NOFB], visible: no
<7> [151.738379] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling PW_3
<7> [151.738535] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling PW_4
<7> [151.738690] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:389:DDI B/PHY B]
<7> [151.738825] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:399:DDI TC1/PHY C]
<7> [151.738958] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:403:DDI TC2/PHY D]
<7> [151.739092] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:405:DP-MST A]
<7> [151.739222] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:406:DP-MST B]
<7> [151.739352] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:407:DP-MST C]
<7> [151.739572] i915 0000:00:02.0: [drm:gen9_dbuf_slices_update [i915]] Updating dbuf slices to 0x3
<7> [151.739738] i915 0000:00:02.0: [drm:intel_dpll_enable [i915]] enable DPLL 0 (active 0x4, on? 0) for [CRTC:387:pipe C]
<7> [151.739872] i915 0000:00:02.0: [drm:intel_dpll_enable [i915]] enabling DPLL 0
<7> [151.740048] i915 0000:00:02.0: [drm:intel_dp_dual_mode_set_tmds_output [i915]] Enabling DP dual mode adaptor TMDS output
<7> [151.744912] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling DDI_IO_B
<7> [151.745083] i915 0000:00:02.0: [drm:intel_enable_transcoder [i915]] enabling pipe C
<7> [151.765137] i915 0000:00:02.0: [drm:verify_connector_state [i915]] [CONNECTOR:390:HDMI-A-1]
<7> [151.765419] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:387:pipe C]
<7> [162.124880] i915 0000:00:02.0: [drm:drm_mode_rmfb_work_fn] Removing [FB:421] from all active usage due to RMFB ioctl
<7> [162.125011] i915 0000:00:02.0: [drm:atomic_remove_fb] Disabling [PLANE:271:plane 1C] because [FB:421] is removed
<7> [162.125131] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:271:plane 1C] ddb ( 0 - 2016) -> ( 0 - 0), size 2016 -> 0
<7> [162.125790] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:271:plane 1C] level *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm -> wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm
<7> [162.126343] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:271:plane 1C] lines 1, 2, 2, 2, 2, 5, 8, 9, 0, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [162.126938] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:271:plane 1C] blocks 16, 33, 33, 33, 33, 81, 129, 145, 30, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [162.127494] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:271:plane 1C] min_ddb 19, 38, 38, 38, 38, 91, 143, 161, 31, 0, 0 -> 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0
<7> [162.128080] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] [CRTC:387:pipe C] data rate 0 num active planes 0
<7> [162.128681] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] QGV point 0: max bw 16761 required 0
<6> [162.144367] [IGT] kms_flip: finished subtest C-HDMI-A1, SUCCESS
<6> [162.147787] [IGT] kms_flip: finished subtest plain-flip-ts-check, FAIL
<6> [162.162419] [IGT] kms_flip: exiting, ret=98
<7> [162.163701] i915 0000:00:02.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x000001dc [0x000001dc]
<7> [162.195964] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CONNECTOR:390:HDMI-A-1] Limiting target display pipe bpp to 24 (EDID bpp 24, max requested bpp 36, max platform bpp 36)
<7> [162.196643] i915 0000:00:02.0: [drm:intel_hdmi_compute_clock [i915]] picking 8 bpc for HDMI output (pipe bpp: 24)
<7> [162.197179] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:151:pipe A] hw max bpp: 24, pipe bpp: 24, dithering: 0
<7> [162.197834] i915 0000:00:02.0: [drm:intel_ddi_compute_config_late [i915]] [ENCODER:389:DDI B/PHY B] [CRTC:151:pipe A]
<7> [162.198382] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.enable (expected no, found yes)
<7> [162.199031] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.active (expected no, found yes)
<7> [162.199631] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in cpu_transcoder (expected -1, found 0)
<7> [162.200188] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in lane_count (expected 0, found 4)
<7> [162.200771] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in output_types (expected 0x00000000, found 0x00000040)
<7> [162.201324] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in framestart_delay (expected 0, found 1)
<7> [162.201914] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 0, found 1920)
<7> [162.202484] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 0, found 2360)
<7> [162.203051] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 0, found 1920)
<7> [162.203642] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 0, found 2360)
<7> [162.204187] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 0, found 2008)
<7> [162.204774] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 0, found 2096)
<7> [162.205317] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 0, found 1080)
<7> [162.205859] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 0, found 1080)
<7> [162.206358] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 0, found 1084)
<7> [162.206917] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 0, found 1089)
<7> [162.207414] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 0, found 1125)
<7> [162.207954] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 0, found 1125)
<7> [162.208401] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 0, found 1920)
<7> [162.208966] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 0, found 2360)
<7> [162.209331] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 0, found 1920)
<7> [162.209714] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 0, found 2360)
<7> [162.210072] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 0, found 2008)
<7> [162.210427] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 0, found 2096)
<7> [162.210813] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 0, found 1080)
<7> [162.211129] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 0, found 1080)
<7> [162.211400] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 0, found 1084)
<7> [162.211693] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 0, found 1089)
<7> [162.211963] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 0, found 1125)
<7> [162.212233] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 0, found 1125)
<7> [162.212528] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in pixel_multiplier (expected 0, found 1)
<7> [162.212798] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 0, found 1)
<7> [162.213068] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 0, found 4)
<7> [162.213338] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in pipe_bpp (expected 0, found 24)
<7> [162.213626] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 0, found 139929)
<7> [162.213895] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 0, found 139929)
<7> [162.214133] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:151:pipe A] fastset requirement not met in port_clock (expected 0, found 139929)
<7> [162.214314] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:151:pipe A] fastset requirement not met, forcing full modeset
<7> [162.214504] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.enable (expected yes, found no)
<7> [162.214685] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.active (expected yes, found no)
<7> [162.214864] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in cpu_transcoder (expected 2, found -1)
<7> [162.215044] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in lane_count (expected 4, found 0)
<7> [162.215223] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in output_types (expected 0x00000040, found 0x00000000)
<7> [162.215403] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in framestart_delay (expected 1, found 0)
<7> [162.215597] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hdisplay (expected 1920, found 0)
<7> [162.215777] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_htotal (expected 2360, found 0)
<7> [162.215958] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hblank_start (expected 1920, found 0)
<7> [162.216137] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hblank_end (expected 2360, found 0)
<7> [162.216315] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hsync_start (expected 2008, found 0)
<7> [162.216503] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_hsync_end (expected 2096, found 0)
<7> [162.216688] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vdisplay (expected 1080, found 0)
<7> [162.216867] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vblank_start (expected 1080, found 0)
<7> [162.217045] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vsync_start (expected 1084, found 0)
<7> [162.217188] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vsync_end (expected 1089, found 0)
<7> [162.217316] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vtotal (expected 1125, found 0)
<7> [162.217444] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_vblank_end (expected 1125, found 0)
<7> [162.217600] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hdisplay (expected 1920, found 0)
<7> [162.217729] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_htotal (expected 2360, found 0)
<7> [162.217857] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hblank_start (expected 1920, found 0)
<7> [162.217986] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hblank_end (expected 2360, found 0)
<7> [162.218114] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hsync_start (expected 2008, found 0)
<7> [162.218242] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_hsync_end (expected 2096, found 0)
<7> [162.218370] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vdisplay (expected 1080, found 0)
<7> [162.218506] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vblank_start (expected 1080, found 0)
<7> [162.218635] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vsync_start (expected 1084, found 0)
<7> [162.218763] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vsync_end (expected 1089, found 0)
<7> [162.218892] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vtotal (expected 1125, found 0)
<7> [162.219020] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_vblank_end (expected 1125, found 0)
<7> [162.219149] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in pixel_multiplier (expected 1, found 0)
<7> [162.219276] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.flags (1) (expected 1, found 0)
<7> [162.219405] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.flags (4) (expected 4, found 0)
<7> [162.219542] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in pipe_bpp (expected 24, found 0)
<7> [162.219671] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.pipe_mode.crtc_clock (expected 139929, found 0)
<7> [162.219800] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in hw.adjusted_mode.crtc_clock (expected 139929, found 0)
<7> [162.219928] i915 0000:00:02.0: [drm:intel_pipe_config_compare [i915]] [CRTC:387:pipe C] fastset requirement not met in port_clock (expected 139929, found 0)
<7> [162.220057] i915 0000:00:02.0: [drm:intel_atomic_check [i915]] [CRTC:387:pipe C] fastset requirement not met, forcing full modeset
<7> [162.220186] i915 0000:00:02.0: [drm:intel_dpll_crtc_put [i915]] [CRTC:387:pipe C] releasing DPLL 0
<7> [162.220350] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:151:pipe A] dbuf slices 0x0 -> 0x3, ddb (0 - 0) -> (0 - 2048), active pipes 0x4 -> 0x1
<7> [162.220488] i915 0000:00:02.0: [drm:skl_compute_wm [i915]] [CRTC:387:pipe C] dbuf slices 0x3 -> 0x0, ddb (0 - 2048) -> (0 - 0), active pipes 0x4 -> 0x1
<7> [162.220629] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:35:plane 1A] ddb ( 0 - 0) -> ( 0 - 2016), size 0 -> 2016
<7> [162.220759] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:145:cursor A] ddb ( 0 - 0) -> (2016 - 2048), size 0 -> 32
<7> [162.220887] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] level wm0, wm1, wm2, wm3, wm4, wm5, wm6, wm7, twm, swm, stwm -> *wm0,*wm1,*wm2,*wm3,*wm4,*wm5,*wm6,*wm7,*twm, swm, stwm
<7> [162.221016] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] lines 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 1, 2, 2, 2, 2, 5, 8, 9, 0, 0, 0
<7> [162.221145] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] blocks 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 16, 33, 33, 33, 33, 81, 129, 145, 30, 0, 0
<7> [162.221272] i915 0000:00:02.0: [drm:skl_print_plane_wm_changes [i915]] [PLANE:35:plane 1A] min_ddb 0, 0, 0, 0, 0, 0, 0, 0, 0, 0, 0 -> 19, 38, 38, 38, 38, 91, 143, 161, 31, 0, 0
<7> [162.221400] i915 0000:00:02.0: [drm:skl_print_plane_ddb_changes [i915]] [PLANE:381:cursor C] ddb (2016 - 2048) -> ( 0 - 0), size 32 -> 0
<7> [162.221558] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] [CRTC:151:pipe A] data rate 559716 num active planes 1
<7> [162.221692] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] QGV point 0: max bw 16761 required 560
<7> [162.221823] i915 0000:00:02.0: [drm:intel_bw_atomic_check [i915]] No SAGV, using single QGV point mask 0x1
<7> [162.221968] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:151:pipe A] min cdclk: 0 kHz -> 69965 kHz
<7> [162.222102] i915 0000:00:02.0: [drm:intel_cdclk_atomic_check [i915]] [CRTC:387:pipe C] min cdclk: 69965 kHz -> 0 kHz
<7> [162.222251] i915 0000:00:02.0: [drm:intel_find_dpll [i915]] [CRTC:151:pipe A] allocated DPLL 0
<7> [162.222388] i915 0000:00:02.0: [drm:intel_dpll_crtc_get [i915]] [CRTC:151:pipe A] reserving DPLL 0
<7> [162.222536] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:151:pipe A] enable: yes [modeset]
<7> [162.222671] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] active: yes, output_types: HDMI (0x40), output format: RGB, sink format: RGB
<7> [162.222804] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] cpu_transcoder: A, pipe bpp: 24, dithering: 0
<7> [162.222935] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] MST master transcoder: <invalid>
<7> [162.223065] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] port sync: master transcoder: <invalid>, slave transcoder bitmask = 0x0
<7> [162.223196] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] joiner: no, pipes: 0x0
<7> [162.223326] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] splitter: disabled, link count 0, overlap 0
<7> [162.223457] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] audio: 0, infoframes: 0, infoframes enabled: 0x0
<7> [162.223599] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] scanline offset: 2
<7> [162.223730] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] framestart delay: 1, MSA timing delay: 0, set context latency: 0
<7> [162.223859] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: no, fixed rr: yes, vmin: 1125, vmax: 1125, flipline: 1125, pipeline full: 42, guardband: 44 vsync start: 0, vsync end: 0
<7> [162.223990] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: vmin vblank: 1081, vmax vblank: 1081, vmin vtotal: 1125, vmax vtotal: 1125
<7> [162.224119] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] vrr: dc balance: no, vmin: 0 vmax: 0 guardband: 0, slope: 0 max increase: 0 max decrease: 0 vblank target: 0
<7> [162.224249] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] requested mode: "1920x1080": 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5
<7> [162.224379] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] adjusted mode: "1920x1080": 53 139930 1920 2008 2096 2360 1080 1084 1089 1125 0x48 0x5
<7> [162.224515] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] crtc timings: clock=139929, hd=1920 hb=1920-2360 hs=2008-2096 ht=2360, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [162.224651] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe mode: "1920x1080": 53 139929 1920 2008 2096 2360 1080 1084 1089 1125 0x40 0x5
<7> [162.224781] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] crtc timings: clock=139929, hd=1920 hb=1920-2360 hs=2008-2096 ht=2360, vd=1080 vb=1080-1125 vs=1084-1089 vt=1125, flags=0x5
<7> [162.224910] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] port clock: 139929, pipe src: 1920x1080+0+0, pixel rate 139929, min cdclk 69965
<7> [162.225044] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] linetime: 135, ips linetime: 0
<7> [162.225177] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] num_scalers: 2, scaler_users: 0x0, scaler_id: -1, scaling_filter: 0
<7> [162.225309] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pch pfit: 0x0+0+0, disabled, force thru: no
<7> [162.225439] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] ips: 0, double wide: 0, drrs: 0
<7> [162.225587] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] dpll_hw_state: cfgcr0: 0x1a6655d, cfgcr1: 0xe84, div0: 0x0, mg_refclkin_ctl: 0x0, hg_clktop2_coreclkctl1: 0x0, mg_clktop2_hsclkctl: 0x0, mg_pll_div0: 0x0, mg_pll_div2: 0x0, mg_pll_lf: 0x0, mg_pll_frac_lock: 0x0, mg_pll_ssc: 0x0, mg_pll_bias: 0x0, mg_pll_tdc_coldst_bias: 0x0
<7> [162.225719] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] csc_mode: 0x0 gamma_mode: 0x0 gamma_enable: 0 csc_enable: 0
<7> [162.225848] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pre csc lut: 0 entries, post csc lut: 0 entries
<7> [162.225977] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: pre offsets: 0x0000 0x0000 0x0000
<7> [162.226107] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [162.226236] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [162.226364] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: coefficients: 0x0000 0x0000 0x0000
<7> [162.226507] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] output csc: post offsets: 0x0000 0x0000 0x0000
<7> [162.226635] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: pre offsets: 0x0000 0x0000 0x0000
<7> [162.226764] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [162.226892] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [162.227021] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: coefficients: 0x0000 0x0000 0x0000
<7> [162.227149] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] pipe csc: post offsets: 0x0000 0x0000 0x0000
<7> [162.227277] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] sharpness strength: 0, sharpness tap size: 0, sharpness enable: 0
<7> [162.227406] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:35:plane 1A] fb: [FB:415] 1920x1080 format = XR24 little-endian (0x34325258) modifier = 0x0, visible: yes
<7> [162.227543] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] rotation: 0x1, scaler: -1, scaling_filter: 0
<7> [162.227672] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] src: 1920.000000x1080.000000+0.000000+0.000000 dst: 1920x1080+0+0
<7> [162.227800] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:65:plane 2A] fb: [NOFB], visible: no
<7> [162.227929] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:95:plane 3A] fb: [NOFB], visible: no
<7> [162.228058] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:125:plane 4A] fb: [NOFB], visible: no
<7> [162.228186] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:135:plane 5A] fb: [NOFB], visible: no
<7> [162.228313] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:145:cursor A] fb: [NOFB], visible: no
<7> [162.228441] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [CRTC:387:pipe C] enable: no [modeset]
<7> [162.228591] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:271:plane 1C] fb: [NOFB], visible: no
<7> [162.228718] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:301:plane 2C] fb: [NOFB], visible: no
<7> [162.228847] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:331:plane 3C] fb: [NOFB], visible: no
<7> [162.228974] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:361:plane 4C] fb: [NOFB], visible: no
<7> [162.229101] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:371:plane 5C] fb: [NOFB], visible: no
<7> [162.229228] i915 0000:00:02.0: [drm:intel_crtc_state_dump [i915]] [PLANE:381:cursor C] fb: [NOFB], visible: no
<7> [162.229515] i915 0000:00:02.0: [drm:intel_disable_transcoder [i915]] disabling pipe C
<7> [162.238580] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling DDI_IO_B
<7> [162.238740] i915 0000:00:02.0: [drm:intel_dp_dual_mode_set_tmds_output [i915]] Disabling DP dual mode adaptor TMDS output
<7> [162.243528] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disable DPLL 0 (active 0x4, on? 1) for [CRTC:387:pipe C]
<7> [162.243686] i915 0000:00:02.0: [drm:intel_dpll_disable [i915]] disabling DPLL 0
<7> [162.243831] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:389:DDI B/PHY B]
<7> [162.243967] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:399:DDI TC1/PHY C]
<7> [162.244101] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:403:DDI TC2/PHY D]
<7> [162.244232] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:405:DP-MST A]
<7> [162.244363] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:406:DP-MST B]
<7> [162.244499] i915 0000:00:02.0: [drm:intel_modeset_verify_disabled [i915]] [ENCODER:407:DP-MST C]
<7> [162.244736] i915 0000:00:02.0: [drm:intel_dpll_enable [i915]] enable DPLL 0 (active 0x1, on? 0) for [CRTC:151:pipe A]
<7> [162.244871] i915 0000:00:02.0: [drm:intel_dpll_enable [i915]] enabling DPLL 0
<7> [162.245048] i915 0000:00:02.0: [drm:intel_dp_dual_mode_set_tmds_output [i915]] Enabling DP dual mode adaptor TMDS output
<7> [162.249842] i915 0000:00:02.0: [drm:intel_power_well_enable [i915]] enabling DDI_IO_B
<7> [162.250017] i915 0000:00:02.0: [drm:intel_enable_transcoder [i915]] enabling pipe A
<7> [162.250407] i915 0000:00:02.0: [drm:intel_fbc_update [i915]] reserved 17694720 bytes of contiguous stolen space for FBC, limit: 1
<7> [162.250557] i915 0000:00:02.0: [drm:intel_fbc_update [i915]] Enabling FBC on [PLANE:35:plane 1A]
<7> [162.269776] i915 0000:00:02.0: [drm:verify_connector_state [i915]] [CONNECTOR:390:HDMI-A-1]
<7> [162.270103] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:151:pipe A]
<7> [162.270852] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling PW_4
<7> [162.271091] i915 0000:00:02.0: [drm:intel_modeset_verify_crtc [i915]] [CRTC:387:pipe C]
<7> [162.271469] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling PW_3
<7> [162.271986] i915 0000:00:02.0: [drm:drm_client_dev_restore] fbdev: ret=0
<6> [162.288994] Console: switching to colour frame buffer device 240x67
|