The point-select sysbench benchmark I ran recently on 10.2 shows rather high time spent in
high resolution timer syscalls (clock_gettime on Linux, and QueryPerformanceCounter on Windows)
The inspection reveals that clock() call introduced inside trx_start_low by this patch https://github.com/MariaDB/server/commit/74961760a4837d2deb33336329c28cf9ad9b4e9e is responsible for the most calls (also, in 10.2, clock() was erroneously done twice).
The call can be replaced by the value of THD::start_utime.
Marko Mäkelä
made changes -
2017-03-23 14:48
Status
Open
[ 1
]
Confirmed
[ 10101
]
Marko Mäkelä
made changes -
2017-03-23 14:50
Fix Version/s
10.1.23
[ 22503
]
Fix Version/s
10.2
[ 14601
]
Vladislav Vaintroub
made changes -
2017-03-23 20:28
Description
The point-select sysbench benchmark I ran recently on 10.2 shows rather high time spent in
high resolution timer syscalls (clock_gettime on Linux, and QueryPerformanceCounter on Windows) - 2-3% of the CPU samples are spent inside this function.
The inspection reveals that clock() call introduced inside trx_start_low by this patch https://github.com/MariaDB/server/commit/74961760a4837d2deb33336329c28cf9ad9b4e9e is responsible for the most calls (also, in 10.2, clock() was erroneously done twice).
The call can be replaced by the value of THD::start_utime.
The point-select sysbench benchmark I ran recently on 10.2 shows rather high time spent in
high resolution timer syscalls (clock_gettime on Linux, and QueryPerformanceCounter on Windows)
The inspection reveals that clock() call introduced inside trx_start_low by this patch https://github.com/MariaDB/server/commit/74961760a4837d2deb33336329c28cf9ad9b4e9e is responsible for the most calls (also, in 10.2, clock() was erroneously done twice).
The call can be replaced by the value of THD::start_utime.
Vladislav Vaintroub
made changes -
2017-03-23 22:35
Fix Version/s
10.2
[ 14601
]
Resolution
Fixed
[ 1
]
Status
Confirmed
[ 10101
]
Closed
[ 6
]
Sergei Golubchik
made changes -
2021-12-06 21:44
Workflow
MariaDB v3
[ 80096
]
MariaDB v4
[ 151845
]
{"report":{"fcp":882.9000000953674,"ttfb":288.7000000476837,"pageVisibility":"visible","entityId":60690,"key":"jira.project.issue.view-issue","isInitial":true,"threshold":1000,"elementTimings":{},"userDeviceMemory":8,"userDeviceProcessors":64,"apdex":1,"journeyId":"29d17f7e-629f-43aa-a021-0ea23fa8589e","navigationType":0,"readyForUser":952.7000000476837,"redirectCount":0,"resourceLoadedEnd":1330.9000000953674,"resourceLoadedStart":294.10000002384186,"resourceTiming":[{"duration":132.89999997615814,"initiatorType":"link","name":"https://jira.mariadb.org/s/2c21342762a6a02add1c328bed317ffd-CDN/lu2bu7/820016/12ta74/0a8bac35585be7fc6c9cc5a0464cd4cf/_/download/contextbatch/css/_super/batch.css","startTime":294.10000002384186,"connectEnd":0,"connectStart":0,"domainLookupEnd":0,"domainLookupStart":0,"fetchStart":294.10000002384186,"redirectEnd":0,"redirectStart":0,"requestStart":0,"responseEnd":427,"responseStart":0,"secureConnectionStart":0},{"duration":132.89999997615814,"initiatorType":"link","name":"https://jira.mariadb.org/s/7ebd35e77e471bc30ff0eba799ebc151-CDN/lu2bu7/820016/12ta74/8679b4946efa1a0bb029a3a22206fb5d/_/download/contextbatch/css/jira.browse.project,project.issue.navigator,jira.view.issue,jira.general,jira.global,atl.general,-_super/batch.css?agile_global_admin_condition=true&jag=true&jira.create.linked.issue=true&slack-enabled=true","startTime":294.40000009536743,"connectEnd":0,"connectStart":0,"domainLookupEnd":0,"domainLookupStart":0,"fetchStart":294.40000009536743,"redirectEnd":0,"redirectStart":0,"requestStart":0,"responseEnd":427.3000000715256,"responseStart":0,"secureConnectionStart":0},{"duration":142,"initiatorType":"script","name":"https://jira.mariadb.org/s/fbf975c0cce4b1abf04784eeae9ba1f4-CDN/lu2bu7/820016/12ta74/0a8bac35585be7fc6c9cc5a0464cd4cf/_/download/contextbatch/js/_super/batch.js?locale=en","startTime":294.60000002384186,"connectEnd":294.60000002384186,"connectStart":294.60000002384186,"domainLookupEnd":294.60000002384186,"domainLookupStart":294.60000002384186,"fetchStart":294.60000002384186,"redirectEnd":0,"redirectStart":0,"requestStart":294.60000002384186,"responseEnd":436.60000002384186,"responseStart":436.60000002384186,"secureConnectionStart":294.60000002384186},{"duration":190.10000002384186,"initiatorType":"script","name":"https://jira.mariadb.org/s/099b33461394b8015fc36c0a4b96e19f-CDN/lu2bu7/820016/12ta74/8679b4946efa1a0bb029a3a22206fb5d/_/download/contextbatch/js/jira.browse.project,project.issue.navigator,jira.view.issue,jira.general,jira.global,atl.general,-_super/batch.js?agile_global_admin_condition=true&jag=true&jira.create.linked.issue=true&locale=en&slack-enabled=true","startTime":294.8000000715256,"connectEnd":294.8000000715256,"connectStart":294.8000000715256,"domainLookupEnd":294.8000000715256,"domainLookupStart":294.8000000715256,"fetchStart":294.8000000715256,"redirectEnd":0,"redirectStart":0,"requestStart":294.8000000715256,"responseEnd":484.90000009536743,"responseStart":484.90000009536743,"secureConnectionStart":294.8000000715256},{"duration":193.79999995231628,"initiatorType":"script","name":"https://jira.mariadb.org/s/94c15bff32baef80f4096a08aceae8bc-CDN/lu2bu7/820016/12ta74/c92c0caa9a024ae85b0ebdbed7fb4bd7/_/download/contextbatch/js/atl.global,-_super/batch.js?locale=en","startTime":294.90000009536743,"connectEnd":294.90000009536743,"connectStart":294.90000009536743,"domainLookupEnd":294.90000009536743,"domainLookupStart":294.90000009536743,"fetchStart":294.90000009536743,"redirectEnd":0,"redirectStart":0,"requestStart":294.90000009536743,"responseEnd":488.7000000476837,"responseStart":488.7000000476837,"secureConnectionStart":294.90000009536743},{"duration":194,"initiatorType":"script","name":"https://jira.mariadb.org/s/d41d8cd98f00b204e9800998ecf8427e-CDN/lu2bu7/820016/12ta74/1.0/_/download/batch/jira.webresources:calendar-en/jira.webresources:calendar-en.js","startTime":295.2000000476837,"connectEnd":295.2000000476837,"connectStart":295.2000000476837,"domainLookupEnd":295.2000000476837,"domainLookupStart":295.2000000476837,"fetchStart":295.2000000476837,"redirectEnd":0,"redirectStart":0,"requestStart":295.2000000476837,"responseEnd":489.2000000476837,"responseStart":489.2000000476837,"secureConnectionStart":295.2000000476837},{"duration":194.29999995231628,"initiatorType":"script","name":"https://jira.mariadb.org/s/d41d8cd98f00b204e9800998ecf8427e-CDN/lu2bu7/820016/12ta74/1.0/_/download/batch/jira.webresources:calendar-localisation-moment/jira.webresources:calendar-localisation-moment.js","startTime":295.3000000715256,"connectEnd":295.3000000715256,"connectStart":295.3000000715256,"domainLookupEnd":295.3000000715256,"domainLookupStart":295.3000000715256,"fetchStart":295.3000000715256,"redirectEnd":0,"redirectStart":0,"requestStart":295.3000000715256,"responseEnd":489.60000002384186,"responseStart":489.60000002384186,"secureConnectionStart":295.3000000715256},{"duration":279.3000000715256,"initiatorType":"link","name":"https://jira.mariadb.org/s/b04b06a02d1959df322d9cded3aeecc1-CDN/lu2bu7/820016/12ta74/a2ff6aa845ffc9a1d22fe23d9ee791fc/_/download/contextbatch/css/jira.global.look-and-feel,-_super/batch.css","startTime":295.5,"connectEnd":0,"connectStart":0,"domainLookupEnd":0,"domainLookupStart":0,"fetchStart":295.5,"redirectEnd":0,"redirectStart":0,"requestStart":0,"responseEnd":574.8000000715256,"responseStart":0,"secureConnectionStart":0},{"duration":194.5,"initiatorType":"script","name":"https://jira.mariadb.org/rest/api/1.0/shortcuts/820016/47140b6e0a9bc2e4913da06536125810/shortcuts.js?context=issuenavigation&context=issueaction","startTime":295.60000002384186,"connectEnd":295.60000002384186,"connectStart":295.60000002384186,"domainLookupEnd":295.60000002384186,"domainLookupStart":295.60000002384186,"fetchStart":295.60000002384186,"redirectEnd":0,"redirectStart":0,"requestStart":295.60000002384186,"responseEnd":490.10000002384186,"responseStart":490.10000002384186,"secureConnectionStart":295.60000002384186},{"duration":279.1999999284744,"initiatorType":"link","name":"https://jira.mariadb.org/s/3ac36323ba5e4eb0af2aa7ac7211b4bb-CDN/lu2bu7/820016/12ta74/d176f0986478cc64f24226b3d20c140d/_/download/contextbatch/css/com.atlassian.jira.projects.sidebar.init,-_super,-project.issue.navigator,-jira.view.issue/batch.css?jira.create.linked.issue=true","startTime":295.8000000715256,"connectEnd":0,"connectStart":0,"domainLookupEnd":0,"domainLookupStart":0,"fetchStart":295.8000000715256,"redirectEnd":0,"redirectStart":0,"requestStart":0,"responseEnd":575,"responseStart":0,"secureConnectionStart":0},{"duration":194.79999995231628,"initiatorType":"script","name":"https://jira.mariadb.org/s/3339d87fa2538a859872f2df449bf8d0-CDN/lu2bu7/820016/12ta74/d176f0986478cc64f24226b3d20c140d/_/download/contextbatch/js/com.atlassian.jira.projects.sidebar.init,-_super,-project.issue.navigator,-jira.view.issue/batch.js?jira.create.linked.issue=true&locale=en","startTime":295.90000009536743,"connectEnd":295.90000009536743,"connectStart":295.90000009536743,"domainLookupEnd":295.90000009536743,"domainLookupStart":295.90000009536743,"fetchStart":295.90000009536743,"redirectEnd":0,"redirectStart":0,"requestStart":295.90000009536743,"responseEnd":490.7000000476837,"responseStart":490.7000000476837,"secureConnectionStart":295.90000009536743},{"duration":357.2000000476837,"initiatorType":"script","name":"https://jira.mariadb.org/s/d41d8cd98f00b204e9800998ecf8427e-CDN/lu2bu7/820016/12ta74/1.0/_/download/batch/jira.webresources:bigpipe-js/jira.webresources:bigpipe-js.js","startTime":296.60000002384186,"connectEnd":296.60000002384186,"connectStart":296.60000002384186,"domainLookupEnd":296.60000002384186,"domainLookupStart":296.60000002384186,"fetchStart":296.60000002384186,"redirectEnd":0,"redirectStart":0,"requestStart":296.60000002384186,"responseEnd":653.8000000715256,"responseStart":653.8000000715256,"secureConnectionStart":296.60000002384186},{"duration":1009.8000000715256,"initiatorType":"script","name":"https://jira.mariadb.org/s/d41d8cd98f00b204e9800998ecf8427e-CDN/lu2bu7/820016/12ta74/1.0/_/download/batch/jira.webresources:bigpipe-init/jira.webresources:bigpipe-init.js","startTime":300.60000002384186,"connectEnd":300.60000002384186,"connectStart":300.60000002384186,"domainLookupEnd":300.60000002384186,"domainLookupStart":300.60000002384186,"fetchStart":300.60000002384186,"redirectEnd":0,"redirectStart":0,"requestStart":300.60000002384186,"responseEnd":1310.4000000953674,"responseStart":1310.4000000953674,"secureConnectionStart":300.60000002384186},{"duration":68.70000004768372,"initiatorType":"xmlhttprequest","name":"https://jira.mariadb.org/rest/webResources/1.0/resources","startTime":585.6000000238419,"connectEnd":585.6000000238419,"connectStart":585.6000000238419,"domainLookupEnd":585.6000000238419,"domainLookupStart":585.6000000238419,"fetchStart":585.6000000238419,"redirectEnd":0,"redirectStart":0,"requestStart":585.6000000238419,"responseEnd":654.3000000715256,"responseStart":654.3000000715256,"secureConnectionStart":585.6000000238419},{"duration":491.5,"initiatorType":"link","name":"https://jira.mariadb.org/s/d5715adaadd168a9002b108b2b039b50-CDN/lu2bu7/820016/12ta74/be4b45e9cec53099498fa61c8b7acba4/_/download/contextbatch/css/jira.project.sidebar,-_super,-project.issue.navigator,-jira.general,-jira.browse.project,-jira.view.issue,-jira.global,-atl.general,-com.atlassian.jira.projects.sidebar.init/batch.css?agile_global_admin_condition=true&jag=true&jira.create.linked.issue=true&slack-enabled=true","startTime":839.4000000953674,"connectEnd":0,"connectStart":0,"domainLookupEnd":0,"domainLookupStart":0,"fetchStart":839.4000000953674,"redirectEnd":0,"redirectStart":0,"requestStart":0,"responseEnd":1330.9000000953674,"responseStart":0,"secureConnectionStart":0},{"duration":476.7000000476837,"initiatorType":"script","name":"https://jira.mariadb.org/s/d41d8cd98f00b204e9800998ecf8427e-CDN/lu2bu7/820016/12ta74/e65b778d185daf5aee24936755b43da6/_/download/contextbatch/js/browser-metrics-plugin.contrib,-_super,-project.issue.navigator,-jira.view.issue,-atl.general/batch.js?agile_global_admin_condition=true&jag=true&jira.create.linked.issue=true&slack-enabled=true","startTime":840.2000000476837,"connectEnd":840.2000000476837,"connectStart":840.2000000476837,"domainLookupEnd":840.2000000476837,"domainLookupStart":840.2000000476837,"fetchStart":840.2000000476837,"redirectEnd":0,"redirectStart":0,"requestStart":840.2000000476837,"responseEnd":1316.9000000953674,"responseStart":1316.9000000953674,"secureConnectionStart":840.2000000476837},{"duration":482.3000000715256,"initiatorType":"script","name":"https://jira.mariadb.org/s/f51ef5507eea4c158f257c66c93b2a3f-CDN/lu2bu7/820016/12ta74/be4b45e9cec53099498fa61c8b7acba4/_/download/contextbatch/js/jira.project.sidebar,-_super,-project.issue.navigator,-jira.general,-jira.browse.project,-jira.view.issue,-jira.global,-atl.general,-com.atlassian.jira.projects.sidebar.init/batch.js?agile_global_admin_condition=true&jag=true&jira.create.linked.issue=true&locale=en&slack-enabled=true","startTime":840.6000000238419,"connectEnd":840.6000000238419,"connectStart":840.6000000238419,"domainLookupEnd":840.6000000238419,"domainLookupStart":840.6000000238419,"fetchStart":840.6000000238419,"redirectEnd":0,"redirectStart":0,"requestStart":840.6000000238419,"responseEnd":1322.9000000953674,"responseStart":1322.9000000953674,"secureConnectionStart":840.6000000238419},{"duration":459.90000009536743,"initiatorType":"script","name":"https://www.google-analytics.com/analytics.js","startTime":877,"connectEnd":0,"connectStart":0,"domainLookupEnd":0,"domainLookupStart":0,"fetchStart":877,"redirectEnd":0,"redirectStart":0,"requestStart":0,"responseEnd":1336.9000000953674,"responseStart":0,"secureConnectionStart":0}],"fetchStart":0,"domainLookupStart":0,"domainLookupEnd":0,"connectStart":0,"connectEnd":0,"requestStart":106,"responseStart":289,"responseEnd":293,"domLoading":292,"domInteractive":1340,"domContentLoadedEventStart":1340,"domContentLoadedEventEnd":1382,"domComplete":1740,"loadEventStart":1740,"loadEventEnd":1741,"userAgent":"Mozilla/5.0 AppleWebKit/537.36 (KHTML, like Gecko; compatible; ClaudeBot/1.0; +claudebot@anthropic.com)","marks":[{"name":"bigPipe.sidebar-id.start","time":1312.4000000953674},{"name":"bigPipe.sidebar-id.end","time":1313.2000000476837},{"name":"bigPipe.activity-panel-pipe-id.start","time":1313.3000000715256},{"name":"bigPipe.activity-panel-pipe-id.end","time":1316.5},{"name":"activityTabFullyLoaded","time":1398.8000000715256}],"measures":[],"correlationId":"b409c8509d0b33","effectiveType":"4g","downlink":9.4,"rtt":0,"serverDuration":127,"dbReadsTimeInMs":24,"dbConnsTimeInMs":33,"applicationHash":"9d11dbea5f4be3d4cc21f03a88dd11d8c8687422","experiments":[]}}
Attached callgraph data taken with perf during the sysbench run