Template load & processing soooo slow

Next topic

Author	Message
Paul Brandt	Tuesday 04 January 2005 2:47:19 am Whenever I clear the Template cache, reloading the pages takes 2 timeouts of 30 seconds each. Then the page reoccurs, and the debuginfo says it took 90% of the time (25 s) to load the template (53%) and to process the template (38%). I'm not sure whether the first two timeouts already do result in stored processing results that are not required to be done anymore during the final, third, access. If so, the amount of processing to be done is really huge. If not, it's quite a coincident that always the third attempt succeeds where the previous two failed. After succesfull template regeneration, in general page load for the same page takes 4-5 s, debug says template processing takes 66%, rest of the time is consumed by the sql, rest of template actions and cache load. Is this number going to increase with larger, more complicated websites? I can live with 4-5 s response times, but not more. Anyway, is this an indication of an instable initialisation / configuration? If so, what could be done to address (diagnose and solve) the misconfiguration, or, if not, what can be done to speed this up? Thanks in advance!

Author

Message

Tuesday 04 January 2005 2:47:19 am

Whenever I clear the Template cache, reloading the pages takes 2 timeouts of 30 seconds each. Then the page reoccurs, and the debuginfo says it took 90% of the time (25 s) to load the template (53%) and to process the template (38%).

I'm not sure whether the first two timeouts already do result in stored processing results that are not required to be done anymore during the final, third, access. If so, the amount of processing to be done is really huge. If not, it's quite a coincident that always the third attempt succeeds where the previous two failed.

After succesfull template regeneration, in general page load for the same page takes 4-5 s, debug says template processing takes 66%, rest of the time is consumed by the sql, rest of template actions and cache load. Is this number going to increase with larger, more complicated websites? I can live with 4-5 s response times, but not more.

Anyway, is this an indication of an instable initialisation / configuration? If so, what could be done to address (diagnose and solve) the misconfiguration, or, if not, what can be done to speed this up?

Thanks in advance!

eZ debug

Timing:	Jan 18 2025 20:54:38
Script start
Timing:	Jan 18 2025 20:54:38
Module start 'layout'
Timing:	Jan 18 2025 20:54:38
Module start 'content'
Timing:	Jan 18 2025 20:54:40
Module end 'content'
Timing:	Jan 18 2025 20:54:40
Script end

Main resources:

Total runtime	1.4257 sec
Peak memory usage	4,096.0000 KB
Database Queries	46

Timing points:

Checkpoint	Start (sec)	Duration (sec)	Memory at start (KB)	Memory used (KB)
Script start	0.0000	0.0051	588.0313	152.6406
Module start 'layout'	0.0051	0.0025	740.6719	39.4609
Module start 'content'	0.0076	1.4164	780.1328	399.7422
Module end 'content'	1.4240	0.0016	1,179.8750	8.1563
Script end	1.4256		1,188.0313

Time accumulators:

Accumulator	Duration (sec)	Duration (%)	Count	Average (sec)
Ini load
Load cache	0.0032	0.2255	16	0.0002
Check MTime	0.0013	0.0944	16	0.0001
Mysql Total
Database connection	0.0005	0.0368	1	0.0005
Mysqli_queries	1.3874	97.3160	46	0.0302
Looping result	0.0005	0.0345	44	0.0000
Template Total	1.3915	97.6	2	0.6958
Template load	0.0023	0.1587	2	0.0011
Template processing	1.3893	97.4451	2	0.6946
Template load and register function	0.0002	0.0119	1	0.0002
states
state_id_array	0.0016	0.1090	1	0.0016
state_identifier_array	0.0015	0.1018	2	0.0007
Override
Cache load	0.0018	0.1275	8	0.0002
Sytem overhead
Fetch class attribute can translate value	0.0006	0.0424	1	0.0006
Fetch class attribute name	0.0009	0.0652	1	0.0009
XML
Image XML parsing	0.0003	0.0199	1	0.0003
class_abstraction
Instantiating content class attribute	0.0000	0.0004	1	0.0000
General
dbfile	0.0021	0.1443	10	0.0002
String conversion	0.0000	0.0007	4	0.0000
Note: percentages do not add up to 100% because some accumulators overlap

Templates used to render the page:

Usage	Requested template	Template	Template loaded
1	node/view/full.tpl	full/forum_topic.tpl	extension/sevenx/design/simple/override/templates/full/forum_topic.tpl
1	content/datatype/view/ezxmltext.tpl	<No override>	extension/community_design/design/suncana/templates/content/datatype/view/ezxmltext.tpl
1	content/datatype/view/ezxmltags/paragraph.tpl	<No override>	extension/ezwebin/design/ezwebin/templates/content/datatype/view/ezxmltags/paragraph.tpl
1	print_pagelayout.tpl	<No override>	extension/community/design/community/templates/print_pagelayout.tpl
Number of times templates used: 4 Number of unique templates used: 4

Time used to render debug report: 0.0001 secs