Profiling results ----------------- Total cpu time observed: 5868ms (out of 6040ms) Number of samples taken: 29 (once every 202ms) ============================================================================== Caller Idx Total Self Name+src Local% ms(pct) ms(pct) Callee ============================================================================== [1] 5868(100.0%) 0(0.0%) ??? ...lects/racket/private/more-scheme.rkt:261:28 profile-thunk16 [2] 100.0% ------------------------------------------------------------------------------ ??? [1] 100.0% [2] 5868(100.0%) 0(0.0%) profile-thunk16 ...e/pkgs/profile-lib/main.rkt:9:0 run [3] 100.0% ------------------------------------------------------------------------------ profile-thunk16 [2] 100.0% [3] 5868(100.0%) 0(0.0%) run ...et-7.5/share/pkgs/profile-lib/main.rkt:39:2 .../more-scheme.rkt:261:28 [4] 100.0% ------------------------------------------------------------------------------ for-loop [11] 1.8% run [3] 98.2% [4] 5868(100.0%) 0(0.0%) .../more-scheme.rkt:261:28 (unknown source) run-improve47 [5] 69.1% prepare-points-intervals [6] 20.6% errors [7] 5.2% eval-errors [8] 3.4% ??? [20] 1.8% ------------------------------------------------------------------------------ .../more-scheme.rkt:261:28 [4] 100.0% [5] 4054(69.1%) 0(0.0%) run-improve47 ...rebuilding/src/mainloop.rkt:346:0 simplify! [9] 100.0% ------------------------------------------------------------------------------ .../more-scheme.rkt:261:28 [4] 100.0% [6] 1206(20.6%) 0(0.0%) prepare-points-intervals ...g/src/points.rkt:120:0 loop [10] 100.0% ------------------------------------------------------------------------------ .../more-scheme.rkt:261:28 [4] 100.0% [7] 408(7.0%) 0(0.0%) errors ...-regraph-rebuilding/src/points.rkt:190:0 for-loop [11] 100.0% ------------------------------------------------------------------------------ .../more-scheme.rkt:261:28 [4] 100.0% [8] 200(3.4%) 0(0.0%) eval-errors ...aph-rebuilding/src/points.rkt:168:0 for-loop [12] 100.0% ------------------------------------------------------------------------------ run-improve47 [5] 100.0% [9] 4054(69.1%) 0(0.0%) simplify! ...aph-rebuilding/src/mainloop.rkt:224:0 ??? [13] 100.0% ------------------------------------------------------------------------------ prepare-points-intervals [6] 100.0% [10] 1206(20.6%) 0(0.0%) loop ...fy-regraph-rebuilding/src/points.rkt:132:4 loop [14] 100.0% ------------------------------------------------------------------------------ errors [7] 100.0% [11] 408(7.0%) 200(3.4%) for-loop ...egraph-rebuilding/src/points.rkt:192:2 .../more-scheme.rkt:261:28 [4] 51.0% ------------------------------------------------------------------------------ eval-errors [8] 100.0% [12] 200(3.4%) 0(0.0%) for-loop ...egraph-rebuilding/src/points.rkt:170:2 ??? [15] 100.0% ------------------------------------------------------------------------------ simplify! [9] 100.0% [13] 4054(69.1%) 0(0.0%) ??? ...graph-rebuilding/src/core/simplify.rkt:38:0 ??? [16] 100.0% ------------------------------------------------------------------------------ loop [10] 100.0% [14] 1206(20.6%) 200(3.4%) loop ...ify-regraph-rebuilding/src/points.rkt:79:2 ??? [20] 66.8% real->precision [18] 16.6% ------------------------------------------------------------------------------ for-loop [12] 100.0% [15] 200(3.4%) 0(0.0%) ??? ...aph-rebuilding/src/syntax/syntax.rkt:214:17 return/no-unsupplied [17] 100.0% ------------------------------------------------------------------------------ ??? [13] 100.0% [16] 4054(69.1%) 0(0.0%) ??? ...graph-rebuilding/src/core/simplify.rkt:56:0 for-loop [19] 100.0% ------------------------------------------------------------------------------ ??? [15] 100.0% [17] 200(3.4%) 200(3.4%) return/no-unsupplied ...ct/private/arr-i.rkt:566:0 ------------------------------------------------------------------------------ loop [14] 100.0% [18] 200(3.4%) 0(0.0%) real->precision ...building/src/programs.rkt:94:11 ??? [20] 100.0% ------------------------------------------------------------------------------ ??? [16] 100.0% [19] 4054(69.1%) 0(0.0%) for-loop ...-rebuilding/src/core/simplify.rkt:76:2 for-loop [21] 100.0% ------------------------------------------------------------------------------ real->precision [18] 16.5% .../more-scheme.rkt:261:28 [4] 17.1% loop [14] 66.4% [20] 1214(20.7%) 208(3.5%) ??? ...tract/private/arrow-higher-order.rkt:375:33 ival-mult [22] 66.4% bf [23] 16.5% ------------------------------------------------------------------------------ for-loop [19] 100.0% [21] 4054(69.1%) 0(0.0%) for-loop ...-rebuilding/src/core/simplify.rkt:80:4 ??? [24] 100.0% ------------------------------------------------------------------------------ ??? [20] 100.0% [22] 806(13.7%) 398(6.8%) ival-mult ...-rebuilding/src/biginterval.rkt:120:0 bfmul [25] 50.6% ------------------------------------------------------------------------------ ??? [20] 100.0% [23] 200(3.4%) 0(0.0%) bf ...ath-lib/math/private/bigfloat/mpfr.rkt:615:2 new-mpfr [28] 100.0% ------------------------------------------------------------------------------ for-loop [21] 100.0% [24] 4054(69.1%) 0(0.0%) ??? ...upwards-no-duplicates/regraph/main.rkt:44:0 find-matches [26] 70.0% for-loop [27] 30.0% ------------------------------------------------------------------------------ ival-mult [22] 100.0% [25] 408(7.0%) 0(0.0%) bfmul ...-lib/math/private/bigfloat/mpfr.rkt:835:4 new-mpfr [28] 100.0% ------------------------------------------------------------------------------ ??? [24] 100.0% [26] 2838(48.4%) 0(0.0%) find-matches ...o-duplicates/regraph/main.rkt:36:0 for-loop [29] 100.0% ------------------------------------------------------------------------------ ??? [24] 100.0% [27] 1216(20.7%) 0(0.0%) for-loop ...ds-no-duplicates/regraph/main.rkt:47:2 for-loop [30] 100.0% ------------------------------------------------------------------------------ bf [23] 32.9% bfmul [25] 67.1% [28] 608(10.4%) 608(10.4%) new-mpfr ...b/math/private/bigfloat/mpfr.rkt:348:0 ------------------------------------------------------------------------------ for-loop [29] 50.0% find-matches [26] 50.0% [29] 2838(48.4%) 214(3.6%) for-loop ...ds-no-duplicates/regraph/main.rkt:38:2 for-loop [29] 50.0% match-e [31] 46.2% ------------------------------------------------------------------------------ for-loop [27] 100.0% [30] 1216(20.7%) 0(0.0%) for-loop ...ds-no-duplicates/regraph/main.rkt:50:4 substitute-e [32] 49.7% merge-egraph-nodes! [33] 18.1% mk-enode-rec! [34] 16.4% dedup-children! [35] 15.8% ------------------------------------------------------------------------------ for-loop [40] 34.8% for-loop [29] 65.2% [31] 2624(44.7%) 410(7.0%) match-e ...s-no-duplicates/regraph/ematch.rkt:35:0 for-loop [36] 88.5% ------------------------------------------------------------------------------ substitute-e [32] 33.4% for-loop [30] 66.6% [32] 604(10.3%) 604(10.3%) substitute-e ...duplicates/regraph/ematch.rkt:55:0 substitute-e [32] 33.4% ------------------------------------------------------------------------------ for-loop [30] 100.0% [33] 220(3.7%) 0(0.0%) merge-egraph-nodes! ...es/regraph/egraph.rkt:144:0 update-leader! [37] 100.0% ------------------------------------------------------------------------------ loop [41] 50.0% for-loop [30] 50.0% [34] 200(3.4%) 0(0.0%) mk-enode-rec! ...plicates/regraph/egraph.rkt:116:0 loop [41] 50.0% for-loop [38] 50.0% ------------------------------------------------------------------------------ for-loop [30] 100.0% [35] 192(3.3%) 0(0.0%) dedup-children! ...licates/regraph/enode.rkt:166:0 loop [39] 100.0% ------------------------------------------------------------------------------ match-e [31] 100.0% [36] 2432(41.4%) 1196(20.4%) for-loop ...no-duplicates/regraph/ematch.rkt:41:11 for-loop [40] 42.0% loop [41] 17.1% do-curry [43] 4.2% foldl [45] 4.1% procedure-reduce-keyword-arity-mask [44] 4.1% ------------------------------------------------------------------------------ merge-egraph-nodes! [33] 100.0% [37] 220(3.7%) 0(0.0%) update-leader! ...licates/regraph/egraph.rkt:213:0 custom-in-set [42] 100.0% ------------------------------------------------------------------------------ mk-enode-rec! [34] 100.0% [38] 200(3.4%) 200(3.4%) for-loop ...o-duplicates/regraph/egraph.rkt:108:10 ------------------------------------------------------------------------------ dedup-children! [35] 16.7% loop [39] 83.3% [39] 192(3.3%) 0(0.0%) loop ...racket-7.5/collects/racket/list.rkt:417:34 loop [39] 83.3% loop [41] 16.7% ------------------------------------------------------------------------------ for-loop [36] 100.0% [40] 1824(31.1%) 0(0.0%) for-loop ...no-duplicates/regraph/ematch.rkt:47:37 match-e [31] 100.0% ------------------------------------------------------------------------------ for-loop [36] 3.1% loop [39] 23.8% mk-enode-rec! [34] 24.8% loop [41] 48.4% [41] 808(13.8%) 608(10.4%) loop (unknown source) loop [41] 48.4% mk-enode-rec! [34] 24.8% ------------------------------------------------------------------------------ update-leader! [37] 100.0% [42] 220(3.7%) 220(3.7%) custom-in-set ...acket/private/set-types.rkt:578:0 ------------------------------------------------------------------------------ for-loop [36] 100.0% [43] 202(3.4%) 202(3.4%) do-curry ...-7.5/collects/racket/function.rkt:71:2 ------------------------------------------------------------------------------ for-loop [36] 100.0% [44] 200(3.4%) 200(3.4%) procedure-reduce-keyword-arity-mask ....rkt:1597:4 ------------------------------------------------------------------------------ for-loop [36] 100.0% [45] 200(3.4%) 0(0.0%) foldl ....5/collects/racket/private/list.rkt:229:4 merge2 [46] 100.0% ------------------------------------------------------------------------------ foldl [45] 100.0% [46] 200(3.4%) 200(3.4%) merge2 ...ds-no-duplicates/regraph/ematch.rkt:20:0 ------------------------------------------------------------------------------