ysr@777: /*
trims@1907:  * Copyright (c) 2001, 2010, Oracle and/or its affiliates. All rights reserved.
ysr@777:  * DO NOT ALTER OR REMOVE COPYRIGHT NOTICES OR THIS FILE HEADER.
ysr@777:  *
ysr@777:  * This code is free software; you can redistribute it and/or modify it
ysr@777:  * under the terms of the GNU General Public License version 2 only, as
ysr@777:  * published by the Free Software Foundation.
ysr@777:  *
ysr@777:  * This code is distributed in the hope that it will be useful, but WITHOUT
ysr@777:  * ANY WARRANTY; without even the implied warranty of MERCHANTABILITY or
ysr@777:  * FITNESS FOR A PARTICULAR PURPOSE.  See the GNU General Public License
ysr@777:  * version 2 for more details (a copy is included in the LICENSE file that
ysr@777:  * accompanied this code).
ysr@777:  *
ysr@777:  * You should have received a copy of the GNU General Public License version
ysr@777:  * 2 along with this work; if not, write to the Free Software Foundation,
ysr@777:  * Inc., 51 Franklin St, Fifth Floor, Boston, MA 02110-1301 USA.
ysr@777:  *
trims@1907:  * Please contact Oracle, 500 Oracle Parkway, Redwood Shores, CA 94065 USA
trims@1907:  * or visit www.oracle.com if you need additional information or have any
trims@1907:  * questions.
ysr@777:  *
ysr@777:  */
ysr@777: 
ysr@777: #include "incls/_precompiled.incl"
ysr@777: #include "incls/_g1CollectorPolicy.cpp.incl"
ysr@777: 
ysr@777: #define PREDICTIONS_VERBOSE 0
ysr@777: 
ysr@777: // <NEW PREDICTION>
ysr@777: 
ysr@777: // Different defaults for different number of GC threads
ysr@777: // They were chosen by running GCOld and SPECjbb on debris with different
ysr@777: //   numbers of GC threads and choosing them based on the results
ysr@777: 
ysr@777: // all the same
ysr@777: static double rs_length_diff_defaults[] = {
ysr@777:   0.0, 0.0, 0.0, 0.0, 0.0, 0.0, 0.0, 0.0
ysr@777: };
ysr@777: 
ysr@777: static double cost_per_card_ms_defaults[] = {
ysr@777:   0.01, 0.005, 0.005, 0.003, 0.003, 0.002, 0.002, 0.0015
ysr@777: };
ysr@777: 
ysr@777: // all the same
ysr@777: static double fully_young_cards_per_entry_ratio_defaults[] = {
ysr@777:   1.0, 1.0, 1.0, 1.0, 1.0, 1.0, 1.0, 1.0
ysr@777: };
ysr@777: 
ysr@777: static double cost_per_entry_ms_defaults[] = {
ysr@777:   0.015, 0.01, 0.01, 0.008, 0.008, 0.0055, 0.0055, 0.005
ysr@777: };
ysr@777: 
ysr@777: static double cost_per_byte_ms_defaults[] = {
ysr@777:   0.00006, 0.00003, 0.00003, 0.000015, 0.000015, 0.00001, 0.00001, 0.000009
ysr@777: };
ysr@777: 
ysr@777: // these should be pretty consistent
ysr@777: static double constant_other_time_ms_defaults[] = {
ysr@777:   5.0, 5.0, 5.0, 5.0, 5.0, 5.0, 5.0, 5.0
ysr@777: };
ysr@777: 
ysr@777: 
ysr@777: static double young_other_cost_per_region_ms_defaults[] = {
ysr@777:   0.3, 0.2, 0.2, 0.15, 0.15, 0.12, 0.12, 0.1
ysr@777: };
ysr@777: 
ysr@777: static double non_young_other_cost_per_region_ms_defaults[] = {
ysr@777:   1.0, 0.7, 0.7, 0.5, 0.5, 0.42, 0.42, 0.30
ysr@777: };
ysr@777: 
ysr@777: // </NEW PREDICTION>
ysr@777: 
ysr@777: G1CollectorPolicy::G1CollectorPolicy() :
ysr@777:   _parallel_gc_threads((ParallelGCThreads > 0) ? ParallelGCThreads : 1),
ysr@777:   _n_pauses(0),
ysr@777:   _recent_CH_strong_roots_times_ms(new TruncatedSeq(NumPrevPausesForHeuristics)),
ysr@777:   _recent_G1_strong_roots_times_ms(new TruncatedSeq(NumPrevPausesForHeuristics)),
ysr@777:   _recent_evac_times_ms(new TruncatedSeq(NumPrevPausesForHeuristics)),
ysr@777:   _recent_pause_times_ms(new TruncatedSeq(NumPrevPausesForHeuristics)),
ysr@777:   _recent_rs_sizes(new TruncatedSeq(NumPrevPausesForHeuristics)),
ysr@777:   _recent_gc_times_ms(new TruncatedSeq(NumPrevPausesForHeuristics)),
ysr@777:   _all_pause_times_ms(new NumberSeq()),
ysr@777:   _stop_world_start(0.0),
ysr@777:   _all_stop_world_times_ms(new NumberSeq()),
ysr@777:   _all_yield_times_ms(new NumberSeq()),
ysr@777: 
ysr@777:   _all_mod_union_times_ms(new NumberSeq()),
ysr@777: 
apetrusenko@1112:   _summary(new Summary()),
apetrusenko@1112:   _abandoned_summary(new AbandonedSummary()),
ysr@777: 
johnc@1325: #ifndef PRODUCT
ysr@777:   _cur_clear_ct_time_ms(0.0),
johnc@1325:   _min_clear_cc_time_ms(-1.0),
johnc@1325:   _max_clear_cc_time_ms(-1.0),
johnc@1325:   _cur_clear_cc_time_ms(0.0),
johnc@1325:   _cum_clear_cc_time_ms(0.0),
johnc@1325:   _num_cc_clears(0L),
johnc@1325: #endif
ysr@777: 
ysr@777:   _region_num_young(0),
ysr@777:   _region_num_tenured(0),
ysr@777:   _prev_region_num_young(0),
ysr@777:   _prev_region_num_tenured(0),
ysr@777: 
ysr@777:   _aux_num(10),
ysr@777:   _all_aux_times_ms(new NumberSeq[_aux_num]),
ysr@777:   _cur_aux_start_times_ms(new double[_aux_num]),
ysr@777:   _cur_aux_times_ms(new double[_aux_num]),
ysr@777:   _cur_aux_times_set(new bool[_aux_num]),
ysr@777: 
ysr@777:   _concurrent_mark_init_times_ms(new TruncatedSeq(NumPrevPausesForHeuristics)),
ysr@777:   _concurrent_mark_remark_times_ms(new TruncatedSeq(NumPrevPausesForHeuristics)),
ysr@777:   _concurrent_mark_cleanup_times_ms(new TruncatedSeq(NumPrevPausesForHeuristics)),
ysr@777: 
ysr@777:   // <NEW PREDICTION>
ysr@777: 
ysr@777:   _alloc_rate_ms_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _prev_collection_pause_end_ms(0.0),
ysr@777:   _pending_card_diff_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _rs_length_diff_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _cost_per_card_ms_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _fully_young_cards_per_entry_ratio_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _partially_young_cards_per_entry_ratio_seq(
ysr@777:                                          new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _cost_per_entry_ms_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _partially_young_cost_per_entry_ms_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _cost_per_byte_ms_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _cost_per_byte_ms_during_cm_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _constant_other_time_ms_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _young_other_cost_per_region_ms_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _non_young_other_cost_per_region_ms_seq(
ysr@777:                                          new TruncatedSeq(TruncatedSeqLength)),
ysr@777: 
ysr@777:   _pending_cards_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _scanned_cards_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777:   _rs_lengths_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777: 
johnc@1186:   _pause_time_target_ms((double) MaxGCPauseMillis),
ysr@777: 
ysr@777:   // </NEW PREDICTION>
ysr@777: 
ysr@777:   _in_young_gc_mode(false),
ysr@777:   _full_young_gcs(true),
ysr@777:   _full_young_pause_num(0),
ysr@777:   _partial_young_pause_num(0),
ysr@777: 
ysr@777:   _during_marking(false),
ysr@777:   _in_marking_window(false),
ysr@777:   _in_marking_window_im(false),
ysr@777: 
ysr@777:   _known_garbage_ratio(0.0),
ysr@777:   _known_garbage_bytes(0),
ysr@777: 
ysr@777:   _young_gc_eff_seq(new TruncatedSeq(TruncatedSeqLength)),
ysr@777: 
ysr@777:    _recent_prev_end_times_for_all_gcs_sec(new TruncatedSeq(NumPrevPausesForHeuristics)),
ysr@777: 
ysr@777:   _recent_CS_bytes_used_before(new TruncatedSeq(NumPrevPausesForHeuristics)),
ysr@777:   _recent_CS_bytes_surviving(new TruncatedSeq(NumPrevPausesForHeuristics)),
ysr@777: 
ysr@777:   _recent_avg_pause_time_ratio(0.0),
ysr@777:   _num_markings(0),
ysr@777:   _n_marks(0),
ysr@777:   _n_pauses_at_mark_end(0),
ysr@777: 
ysr@777:   _all_full_gc_times_ms(new NumberSeq()),
ysr@777: 
ysr@777:   // G1PausesBtwnConcMark defaults to -1
ysr@777:   // so the hack is to do the cast  QQQ FIXME
ysr@777:   _pauses_btwn_concurrent_mark((size_t)G1PausesBtwnConcMark),
ysr@777:   _n_marks_since_last_pause(0),
tonyp@1794:   _initiate_conc_mark_if_possible(false),
tonyp@1794:   _during_initial_mark_pause(false),
ysr@777:   _should_revert_to_full_young_gcs(false),
ysr@777:   _last_full_young_gc(false),
ysr@777: 
ysr@777:   _prev_collection_pause_used_at_end_bytes(0),
ysr@777: 
ysr@777:   _collection_set(NULL),
johnc@1829:   _collection_set_size(0),
johnc@1829:   _collection_set_bytes_used_before(0),
johnc@1829: 
johnc@1829:   // Incremental CSet attributes
johnc@1829:   _inc_cset_build_state(Inactive),
johnc@1829:   _inc_cset_head(NULL),
johnc@1829:   _inc_cset_tail(NULL),
johnc@1829:   _inc_cset_size(0),
johnc@1829:   _inc_cset_young_index(0),
johnc@1829:   _inc_cset_bytes_used_before(0),
johnc@1829:   _inc_cset_max_finger(NULL),
johnc@1829:   _inc_cset_recorded_young_bytes(0),
johnc@1829:   _inc_cset_recorded_rs_lengths(0),
johnc@1829:   _inc_cset_predicted_elapsed_time_ms(0.0),
johnc@1829:   _inc_cset_predicted_bytes_to_copy(0),
johnc@1829: 
ysr@777: #ifdef _MSC_VER // the use of 'this' below gets a warning, make it go away
ysr@777: #pragma warning( disable:4355 ) // 'this' : used in base member initializer list
ysr@777: #endif // _MSC_VER
ysr@777: 
ysr@777:   _short_lived_surv_rate_group(new SurvRateGroup(this, "Short Lived",
ysr@777:                                                  G1YoungSurvRateNumRegionsSummary)),
ysr@777:   _survivor_surv_rate_group(new SurvRateGroup(this, "Survivor",
apetrusenko@980:                                               G1YoungSurvRateNumRegionsSummary)),
ysr@777:   // add here any more surv rate groups
apetrusenko@980:   _recorded_survivor_regions(0),
apetrusenko@980:   _recorded_survivor_head(NULL),
apetrusenko@980:   _recorded_survivor_tail(NULL),
tonyp@1791:   _survivors_age_table(true),
tonyp@1791: 
tonyp@1791:   _gc_overhead_perc(0.0)
apetrusenko@980: 
ysr@777: {
tonyp@1377:   // Set up the region size and associated fields. Given that the
tonyp@1377:   // policy is created before the heap, we have to set this up here,
tonyp@1377:   // so it's done as soon as possible.
tonyp@1377:   HeapRegion::setup_heap_region_size(Arguments::min_heap_size());
iveresov@1696:   HeapRegionRemSet::setup_remset_size();
tonyp@1377: 
apetrusenko@1826:   // Verify PLAB sizes
apetrusenko@1826:   const uint region_size = HeapRegion::GrainWords;
apetrusenko@1826:   if (YoungPLABSize > region_size || OldPLABSize > region_size) {
apetrusenko@1826:     char buffer[128];
apetrusenko@1826:     jio_snprintf(buffer, sizeof(buffer), "%sPLABSize should be at most %u",
apetrusenko@1826:                  OldPLABSize > region_size ? "Old" : "Young", region_size);
apetrusenko@1826:     vm_exit_during_initialization(buffer);
apetrusenko@1826:   }
apetrusenko@1826: 
ysr@777:   _recent_prev_end_times_for_all_gcs_sec->add(os::elapsedTime());
ysr@777:   _prev_collection_pause_end_ms = os::elapsedTime() * 1000.0;
ysr@777: 
tonyp@1966:   _par_last_gc_worker_start_times_ms = new double[_parallel_gc_threads];
ysr@777:   _par_last_ext_root_scan_times_ms = new double[_parallel_gc_threads];
ysr@777:   _par_last_mark_stack_scan_times_ms = new double[_parallel_gc_threads];
ysr@777: 
ysr@777:   _par_last_update_rs_times_ms = new double[_parallel_gc_threads];
ysr@777:   _par_last_update_rs_processed_buffers = new double[_parallel_gc_threads];
ysr@777: 
ysr@777:   _par_last_scan_rs_times_ms = new double[_parallel_gc_threads];
ysr@777: 
ysr@777:   _par_last_obj_copy_times_ms = new double[_parallel_gc_threads];
ysr@777: 
ysr@777:   _par_last_termination_times_ms = new double[_parallel_gc_threads];
tonyp@1966:   _par_last_termination_attempts = new double[_parallel_gc_threads];
tonyp@1966:   _par_last_gc_worker_end_times_ms = new double[_parallel_gc_threads];
ysr@777: 
ysr@777:   // start conservatively
johnc@1186:   _expensive_region_limit_ms = 0.5 * (double) MaxGCPauseMillis;
ysr@777: 
ysr@777:   // <NEW PREDICTION>
ysr@777: 
ysr@777:   int index;
ysr@777:   if (ParallelGCThreads == 0)
ysr@777:     index = 0;
ysr@777:   else if (ParallelGCThreads > 8)
ysr@777:     index = 7;
ysr@777:   else
ysr@777:     index = ParallelGCThreads - 1;
ysr@777: 
ysr@777:   _pending_card_diff_seq->add(0.0);
ysr@777:   _rs_length_diff_seq->add(rs_length_diff_defaults[index]);
ysr@777:   _cost_per_card_ms_seq->add(cost_per_card_ms_defaults[index]);
ysr@777:   _fully_young_cards_per_entry_ratio_seq->add(
ysr@777:                             fully_young_cards_per_entry_ratio_defaults[index]);
ysr@777:   _cost_per_entry_ms_seq->add(cost_per_entry_ms_defaults[index]);
ysr@777:   _cost_per_byte_ms_seq->add(cost_per_byte_ms_defaults[index]);
ysr@777:   _constant_other_time_ms_seq->add(constant_other_time_ms_defaults[index]);
ysr@777:   _young_other_cost_per_region_ms_seq->add(
ysr@777:                                young_other_cost_per_region_ms_defaults[index]);
ysr@777:   _non_young_other_cost_per_region_ms_seq->add(
ysr@777:                            non_young_other_cost_per_region_ms_defaults[index]);
ysr@777: 
ysr@777:   // </NEW PREDICTION>
ysr@777: 
tonyp@1965:   // Below, we might need to calculate the pause time target based on
tonyp@1965:   // the pause interval. When we do so we are going to give G1 maximum
tonyp@1965:   // flexibility and allow it to do pauses when it needs to. So, we'll
tonyp@1965:   // arrange that the pause interval to be pause time target + 1 to
tonyp@1965:   // ensure that a) the pause time target is maximized with respect to
tonyp@1965:   // the pause interval and b) we maintain the invariant that pause
tonyp@1965:   // time target < pause interval. If the user does not want this
tonyp@1965:   // maximum flexibility, they will have to set the pause interval
tonyp@1965:   // explicitly.
tonyp@1965: 
tonyp@1965:   // First make sure that, if either parameter is set, its value is
tonyp@1965:   // reasonable.
tonyp@1965:   if (!FLAG_IS_DEFAULT(MaxGCPauseMillis)) {
tonyp@1965:     if (MaxGCPauseMillis < 1) {
tonyp@1965:       vm_exit_during_initialization("MaxGCPauseMillis should be "
tonyp@1965:                                     "greater than 0");
tonyp@1965:     }
tonyp@1965:   }
tonyp@1965:   if (!FLAG_IS_DEFAULT(GCPauseIntervalMillis)) {
tonyp@1965:     if (GCPauseIntervalMillis < 1) {
tonyp@1965:       vm_exit_during_initialization("GCPauseIntervalMillis should be "
tonyp@1965:                                     "greater than 0");
tonyp@1965:     }
tonyp@1965:   }
tonyp@1965: 
tonyp@1965:   // Then, if the pause time target parameter was not set, set it to
tonyp@1965:   // the default value.
tonyp@1965:   if (FLAG_IS_DEFAULT(MaxGCPauseMillis)) {
tonyp@1965:     if (FLAG_IS_DEFAULT(GCPauseIntervalMillis)) {
tonyp@1965:       // The default pause time target in G1 is 200ms
tonyp@1965:       FLAG_SET_DEFAULT(MaxGCPauseMillis, 200);
tonyp@1965:     } else {
tonyp@1965:       // We do not allow the pause interval to be set without the
tonyp@1965:       // pause time target
tonyp@1965:       vm_exit_during_initialization("GCPauseIntervalMillis cannot be set "
tonyp@1965:                                     "without setting MaxGCPauseMillis");
tonyp@1965:     }
tonyp@1965:   }
tonyp@1965: 
tonyp@1965:   // Then, if the interval parameter was not set, set it according to
tonyp@1965:   // the pause time target (this will also deal with the case when the
tonyp@1965:   // pause time target is the default value).
tonyp@1965:   if (FLAG_IS_DEFAULT(GCPauseIntervalMillis)) {
tonyp@1965:     FLAG_SET_DEFAULT(GCPauseIntervalMillis, MaxGCPauseMillis + 1);
tonyp@1965:   }
tonyp@1965: 
tonyp@1965:   // Finally, make sure that the two parameters are consistent.
tonyp@1965:   if (MaxGCPauseMillis >= GCPauseIntervalMillis) {
tonyp@1965:     char buffer[256];
tonyp@1965:     jio_snprintf(buffer, 256,
tonyp@1965:                  "MaxGCPauseMillis (%u) should be less than "
tonyp@1965:                  "GCPauseIntervalMillis (%u)",
tonyp@1965:                  MaxGCPauseMillis, GCPauseIntervalMillis);
tonyp@1965:     vm_exit_during_initialization(buffer);
tonyp@1965:   }
tonyp@1965: 
tonyp@1965:   double max_gc_time = (double) MaxGCPauseMillis / 1000.0;
johnc@1186:   double time_slice  = (double) GCPauseIntervalMillis / 1000.0;
ysr@777:   _mmu_tracker = new G1MMUTrackerQueue(time_slice, max_gc_time);
johnc@1186:   _sigma = (double) G1ConfidencePercent / 100.0;
ysr@777: 
ysr@777:   // start conservatively (around 50ms is about right)
ysr@777:   _concurrent_mark_init_times_ms->add(0.05);
ysr@777:   _concurrent_mark_remark_times_ms->add(0.05);
ysr@777:   _concurrent_mark_cleanup_times_ms->add(0.20);
ysr@777:   _tenuring_threshold = MaxTenuringThreshold;
ysr@777: 
tonyp@1717:   // if G1FixedSurvivorSpaceSize is 0 which means the size is not
tonyp@1717:   // fixed, then _max_survivor_regions will be calculated at
johnc@1829:   // calculate_young_list_target_length during initialization
tonyp@1717:   _max_survivor_regions = G1FixedSurvivorSpaceSize / HeapRegion::GrainBytes;
apetrusenko@980: 
tonyp@1791:   assert(GCTimeRatio > 0,
tonyp@1791:          "we should have set it to a default value set_g1_gc_flags() "
tonyp@1791:          "if a user set it to 0");
tonyp@1791:   _gc_overhead_perc = 100.0 * (1.0 / (1.0 + GCTimeRatio));
tonyp@1791: 
ysr@777:   initialize_all();
ysr@777: }
ysr@777: 
ysr@777: // Increment "i", mod "len"
ysr@777: static void inc_mod(int& i, int len) {
ysr@777:   i++; if (i == len) i = 0;
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::initialize_flags() {
ysr@777:   set_min_alignment(HeapRegion::GrainBytes);
ysr@777:   set_max_alignment(GenRemSet::max_alignment_constraint(rem_set_name()));
apetrusenko@982:   if (SurvivorRatio < 1) {
apetrusenko@982:     vm_exit_during_initialization("Invalid survivor ratio specified");
apetrusenko@982:   }
ysr@777:   CollectorPolicy::initialize_flags();
ysr@777: }
ysr@777: 
tonyp@1720: // The easiest way to deal with the parsing of the NewSize /
tonyp@1720: // MaxNewSize / etc. parameteres is to re-use the code in the
tonyp@1720: // TwoGenerationCollectorPolicy class. This is similar to what
tonyp@1720: // ParallelScavenge does with its GenerationSizer class (see
tonyp@1720: // ParallelScavengeHeap::initialize()). We might change this in the
tonyp@1720: // future, but it's a good start.
tonyp@1720: class G1YoungGenSizer : public TwoGenerationCollectorPolicy {
tonyp@1720:   size_t size_to_region_num(size_t byte_size) {
tonyp@1720:     return MAX2((size_t) 1, byte_size / HeapRegion::GrainBytes);
tonyp@1720:   }
tonyp@1720: 
tonyp@1720: public:
tonyp@1720:   G1YoungGenSizer() {
tonyp@1720:     initialize_flags();
tonyp@1720:     initialize_size_info();
tonyp@1720:   }
tonyp@1720: 
tonyp@1720:   size_t min_young_region_num() {
tonyp@1720:     return size_to_region_num(_min_gen0_size);
tonyp@1720:   }
tonyp@1720:   size_t initial_young_region_num() {
tonyp@1720:     return size_to_region_num(_initial_gen0_size);
tonyp@1720:   }
tonyp@1720:   size_t max_young_region_num() {
tonyp@1720:     return size_to_region_num(_max_gen0_size);
tonyp@1720:   }
tonyp@1720: };
tonyp@1720: 
ysr@777: void G1CollectorPolicy::init() {
ysr@777:   // Set aside an initial future to_space.
ysr@777:   _g1 = G1CollectedHeap::heap();
ysr@777: 
ysr@777:   assert(Heap_lock->owned_by_self(), "Locking discipline.");
ysr@777: 
apetrusenko@980:   initialize_gc_policy_counters();
apetrusenko@980: 
ysr@777:   if (G1Gen) {
ysr@777:     _in_young_gc_mode = true;
ysr@777: 
tonyp@1720:     G1YoungGenSizer sizer;
tonyp@1720:     size_t initial_region_num = sizer.initial_young_region_num();
tonyp@1720: 
tonyp@1720:     if (UseAdaptiveSizePolicy) {
ysr@777:       set_adaptive_young_list_length(true);
ysr@777:       _young_list_fixed_length = 0;
ysr@777:     } else {
ysr@777:       set_adaptive_young_list_length(false);
tonyp@1720:       _young_list_fixed_length = initial_region_num;
ysr@777:     }
johnc@1829:     _free_regions_at_end_of_collection = _g1->free_regions();
johnc@1829:     calculate_young_list_min_length();
johnc@1829:     guarantee( _young_list_min_length == 0, "invariant, not enough info" );
johnc@1829:     calculate_young_list_target_length();
johnc@1829:   } else {
ysr@777:      _young_list_fixed_length = 0;
ysr@777:     _in_young_gc_mode = false;
ysr@777:   }
johnc@1829: 
johnc@1829:   // We may immediately start allocating regions and placing them on the
johnc@1829:   // collection set list. Initialize the per-collection set info
johnc@1829:   start_incremental_cset_building();
ysr@777: }
ysr@777: 
apetrusenko@980: // Create the jstat counters for the policy.
apetrusenko@980: void G1CollectorPolicy::initialize_gc_policy_counters()
apetrusenko@980: {
apetrusenko@980:   _gc_policy_counters = new GCPolicyCounters("GarbageFirst", 1, 2 + G1Gen);
apetrusenko@980: }
apetrusenko@980: 
ysr@777: void G1CollectorPolicy::calculate_young_list_min_length() {
ysr@777:   _young_list_min_length = 0;
ysr@777: 
ysr@777:   if (!adaptive_young_list_length())
ysr@777:     return;
ysr@777: 
ysr@777:   if (_alloc_rate_ms_seq->num() > 3) {
ysr@777:     double now_sec = os::elapsedTime();
ysr@777:     double when_ms = _mmu_tracker->when_max_gc_sec(now_sec) * 1000.0;
ysr@777:     double alloc_rate_ms = predict_alloc_rate_ms();
ysr@777:     int min_regions = (int) ceil(alloc_rate_ms * when_ms);
johnc@1829:     int current_region_num = (int) _g1->young_list()->length();
ysr@777:     _young_list_min_length = min_regions + current_region_num;
ysr@777:   }
ysr@777: }
ysr@777: 
johnc@1829: void G1CollectorPolicy::calculate_young_list_target_length() {
ysr@777:   if (adaptive_young_list_length()) {
ysr@777:     size_t rs_lengths = (size_t) get_new_prediction(_rs_lengths_seq);
johnc@1829:     calculate_young_list_target_length(rs_lengths);
ysr@777:   } else {
ysr@777:     if (full_young_gcs())
ysr@777:       _young_list_target_length = _young_list_fixed_length;
ysr@777:     else
ysr@777:       _young_list_target_length = _young_list_fixed_length / 2;
johnc@1829: 
ysr@777:     _young_list_target_length = MAX2(_young_list_target_length, (size_t)1);
ysr@777:   }
apetrusenko@980:   calculate_survivors_policy();
ysr@777: }
ysr@777: 
johnc@1829: void G1CollectorPolicy::calculate_young_list_target_length(size_t rs_lengths) {
ysr@777:   guarantee( adaptive_young_list_length(), "pre-condition" );
johnc@1829:   guarantee( !_in_marking_window || !_last_full_young_gc, "invariant" );
ysr@777: 
ysr@777:   double start_time_sec = os::elapsedTime();
tonyp@1717:   size_t min_reserve_perc = MAX2((size_t)2, (size_t)G1ReservePercent);
ysr@777:   min_reserve_perc = MIN2((size_t) 50, min_reserve_perc);
ysr@777:   size_t reserve_regions =
ysr@777:     (size_t) ((double) min_reserve_perc * (double) _g1->n_regions() / 100.0);
ysr@777: 
ysr@777:   if (full_young_gcs() && _free_regions_at_end_of_collection > 0) {
ysr@777:     // we are in fully-young mode and there are free regions in the heap
ysr@777: 
apetrusenko@980:     double survivor_regions_evac_time =
apetrusenko@980:         predict_survivor_regions_evac_time();
apetrusenko@980: 
ysr@777:     double target_pause_time_ms = _mmu_tracker->max_gc_time() * 1000.0;
ysr@777:     size_t pending_cards = (size_t) get_new_prediction(_pending_cards_seq);
ysr@777:     size_t adj_rs_lengths = rs_lengths + predict_rs_length_diff();
johnc@1829:     size_t scanned_cards = predict_young_card_num(adj_rs_lengths);
apetrusenko@980:     double base_time_ms = predict_base_elapsed_time_ms(pending_cards, scanned_cards)
apetrusenko@980:                           + survivor_regions_evac_time;
johnc@1829: 
ysr@777:     // the result
ysr@777:     size_t final_young_length = 0;
johnc@1829: 
johnc@1829:     size_t init_free_regions =
johnc@1829:       MAX2((size_t)0, _free_regions_at_end_of_collection - reserve_regions);
johnc@1829: 
johnc@1829:     // if we're still under the pause target...
johnc@1829:     if (base_time_ms <= target_pause_time_ms) {
johnc@1829:       // We make sure that the shortest young length that makes sense
johnc@1829:       // fits within the target pause time.
johnc@1829:       size_t min_young_length = 1;
johnc@1829: 
johnc@1829:       if (predict_will_fit(min_young_length, base_time_ms,
johnc@1829:                                      init_free_regions, target_pause_time_ms)) {
johnc@1829:         // The shortest young length will fit within the target pause time;
johnc@1829:         // we'll now check whether the absolute maximum number of young
johnc@1829:         // regions will fit in the target pause time. If not, we'll do
johnc@1829:         // a binary search between min_young_length and max_young_length
johnc@1829:         size_t abs_max_young_length = _free_regions_at_end_of_collection - 1;
johnc@1829:         size_t max_young_length = abs_max_young_length;
johnc@1829: 
johnc@1829:         if (max_young_length > min_young_length) {
johnc@1829:           // Let's check if the initial max young length will fit within the
johnc@1829:           // target pause. If so then there is no need to search for a maximal
johnc@1829:           // young length - we'll return the initial maximum
johnc@1829: 
johnc@1829:           if (predict_will_fit(max_young_length, base_time_ms,
johnc@1829:                                 init_free_regions, target_pause_time_ms)) {
johnc@1829:             // The maximum young length will satisfy the target pause time.
johnc@1829:             // We are done so set min young length to this maximum length.
johnc@1829:             // The code after the loop will then set final_young_length using
johnc@1829:             // the value cached in the minimum length.
johnc@1829:             min_young_length = max_young_length;
johnc@1829:           } else {
johnc@1829:             // The maximum possible number of young regions will not fit within
johnc@1829:             // the target pause time so let's search....
johnc@1829: 
johnc@1829:             size_t diff = (max_young_length - min_young_length) / 2;
johnc@1829:             max_young_length = min_young_length + diff;
johnc@1829: 
johnc@1829:             while (max_young_length > min_young_length) {
johnc@1829:               if (predict_will_fit(max_young_length, base_time_ms,
johnc@1829:                                         init_free_regions, target_pause_time_ms)) {
johnc@1829: 
johnc@1829:                 // The current max young length will fit within the target
johnc@1829:                 // pause time. Note we do not exit the loop here. By setting
johnc@1829:                 // min = max, and then increasing the max below means that
johnc@1829:                 // we will continue searching for an upper bound in the
johnc@1829:                 // range [max..max+diff]
johnc@1829:                 min_young_length = max_young_length;
johnc@1829:               }
johnc@1829:               diff = (max_young_length - min_young_length) / 2;
johnc@1829:               max_young_length = min_young_length + diff;
johnc@1829:             }
johnc@1829:             // the above loop found a maximal young length that will fit
johnc@1829:             // within the target pause time.
johnc@1829:           }
johnc@1829:           assert(min_young_length <= abs_max_young_length, "just checking");
johnc@1829:         }
johnc@1829:         final_young_length = min_young_length;
johnc@1829:       }
ysr@777:     }
johnc@1829:     // and we're done!
ysr@777: 
ysr@777:     // we should have at least one region in the target young length
apetrusenko@980:     _young_list_target_length =
apetrusenko@980:         MAX2((size_t) 1, final_young_length + _recorded_survivor_regions);
ysr@777: 
ysr@777:     // let's keep an eye of how long we spend on this calculation
ysr@777:     // right now, I assume that we'll print it when we need it; we
ysr@777:     // should really adde it to the breakdown of a pause
ysr@777:     double end_time_sec = os::elapsedTime();
ysr@777:     double elapsed_time_ms = (end_time_sec - start_time_sec) * 1000.0;
ysr@777: 
johnc@1829: #ifdef TRACE_CALC_YOUNG_LENGTH
ysr@777:     // leave this in for debugging, just in case
johnc@1829:     gclog_or_tty->print_cr("target = %1.1lf ms, young = " SIZE_FORMAT ", "
johnc@1829:                            "elapsed %1.2lf ms, (%s%s) " SIZE_FORMAT SIZE_FORMAT,
ysr@777:                            target_pause_time_ms,
johnc@1829:                            _young_list_target_length
ysr@777:                            elapsed_time_ms,
ysr@777:                            full_young_gcs() ? "full" : "partial",
tonyp@1794:                            during_initial_mark_pause() ? " i-m" : "",
apetrusenko@980:                            _in_marking_window,
apetrusenko@980:                            _in_marking_window_im);
johnc@1829: #endif // TRACE_CALC_YOUNG_LENGTH
ysr@777: 
ysr@777:     if (_young_list_target_length < _young_list_min_length) {
johnc@1829:       // bummer; this means that, if we do a pause when the maximal
johnc@1829:       // length dictates, we'll violate the pause spacing target (the
ysr@777:       // min length was calculate based on the application's current
ysr@777:       // alloc rate);
ysr@777: 
ysr@777:       // so, we have to bite the bullet, and allocate the minimum
ysr@777:       // number. We'll violate our target, but we just can't meet it.
ysr@777: 
johnc@1829: #ifdef TRACE_CALC_YOUNG_LENGTH
ysr@777:       // leave this in for debugging, just in case
ysr@777:       gclog_or_tty->print_cr("adjusted target length from "
johnc@1829:                              SIZE_FORMAT " to " SIZE_FORMAT,
johnc@1829:                              _young_list_target_length, _young_list_min_length);
johnc@1829: #endif // TRACE_CALC_YOUNG_LENGTH
johnc@1829: 
johnc@1829:       _young_list_target_length = _young_list_min_length;
ysr@777:     }
ysr@777:   } else {
ysr@777:     // we are in a partially-young mode or we've run out of regions (due
ysr@777:     // to evacuation failure)
ysr@777: 
johnc@1829: #ifdef TRACE_CALC_YOUNG_LENGTH
ysr@777:     // leave this in for debugging, just in case
ysr@777:     gclog_or_tty->print_cr("(partial) setting target to " SIZE_FORMAT
johnc@1829:                            _young_list_min_length);
johnc@1829: #endif // TRACE_CALC_YOUNG_LENGTH
johnc@1829:     // we'll do the pause as soon as possible by choosing the minimum
ysr@777:     _young_list_target_length =
ysr@777:       MAX2(_young_list_min_length, (size_t) 1);
ysr@777:   }
ysr@777: 
ysr@777:   _rs_lengths_prediction = rs_lengths;
ysr@777: }
ysr@777: 
johnc@1829: // This is used by: calculate_young_list_target_length(rs_length). It
johnc@1829: // returns true iff:
johnc@1829: //   the predicted pause time for the given young list will not overflow
johnc@1829: //   the target pause time
johnc@1829: // and:
johnc@1829: //   the predicted amount of surviving data will not overflow the
johnc@1829: //   the amount of free space available for survivor regions.
johnc@1829: //
ysr@777: bool
johnc@1829: G1CollectorPolicy::predict_will_fit(size_t young_length,
johnc@1829:                                     double base_time_ms,
johnc@1829:                                     size_t init_free_regions,
johnc@1829:                                     double target_pause_time_ms) {
ysr@777: 
ysr@777:   if (young_length >= init_free_regions)
ysr@777:     // end condition 1: not enough space for the young regions
ysr@777:     return false;
ysr@777: 
ysr@777:   double accum_surv_rate_adj = 0.0;
ysr@777:   double accum_surv_rate =
ysr@777:     accum_yg_surv_rate_pred((int)(young_length - 1)) - accum_surv_rate_adj;
johnc@1829: 
ysr@777:   size_t bytes_to_copy =
ysr@777:     (size_t) (accum_surv_rate * (double) HeapRegion::GrainBytes);
johnc@1829: 
ysr@777:   double copy_time_ms = predict_object_copy_time_ms(bytes_to_copy);
johnc@1829: 
ysr@777:   double young_other_time_ms =
johnc@1829:                        predict_young_other_time_ms(young_length);
johnc@1829: 
ysr@777:   double pause_time_ms =
johnc@1829:                    base_time_ms + copy_time_ms + young_other_time_ms;
ysr@777: 
ysr@777:   if (pause_time_ms > target_pause_time_ms)
ysr@777:     // end condition 2: over the target pause time
ysr@777:     return false;
ysr@777: 
ysr@777:   size_t free_bytes =
ysr@777:                  (init_free_regions - young_length) * HeapRegion::GrainBytes;
ysr@777: 
ysr@777:   if ((2.0 + sigma()) * (double) bytes_to_copy > (double) free_bytes)
ysr@777:     // end condition 3: out of to-space (conservatively)
ysr@777:     return false;
ysr@777: 
ysr@777:   // success!
ysr@777:   return true;
ysr@777: }
ysr@777: 
apetrusenko@980: double G1CollectorPolicy::predict_survivor_regions_evac_time() {
apetrusenko@980:   double survivor_regions_evac_time = 0.0;
apetrusenko@980:   for (HeapRegion * r = _recorded_survivor_head;
apetrusenko@980:        r != NULL && r != _recorded_survivor_tail->get_next_young_region();
apetrusenko@980:        r = r->get_next_young_region()) {
apetrusenko@980:     survivor_regions_evac_time += predict_region_elapsed_time_ms(r, true);
apetrusenko@980:   }
apetrusenko@980:   return survivor_regions_evac_time;
apetrusenko@980: }
apetrusenko@980: 
ysr@777: void G1CollectorPolicy::check_prediction_validity() {
ysr@777:   guarantee( adaptive_young_list_length(), "should not call this otherwise" );
ysr@777: 
johnc@1829:   size_t rs_lengths = _g1->young_list()->sampled_rs_lengths();
ysr@777:   if (rs_lengths > _rs_lengths_prediction) {
ysr@777:     // add 10% to avoid having to recalculate often
ysr@777:     size_t rs_lengths_prediction = rs_lengths * 1100 / 1000;
johnc@1829:     calculate_young_list_target_length(rs_lengths_prediction);
ysr@777:   }
ysr@777: }
ysr@777: 
ysr@777: HeapWord* G1CollectorPolicy::mem_allocate_work(size_t size,
ysr@777:                                                bool is_tlab,
ysr@777:                                                bool* gc_overhead_limit_was_exceeded) {
ysr@777:   guarantee(false, "Not using this policy feature yet.");
ysr@777:   return NULL;
ysr@777: }
ysr@777: 
ysr@777: // This method controls how a collector handles one or more
ysr@777: // of its generations being fully allocated.
ysr@777: HeapWord* G1CollectorPolicy::satisfy_failed_allocation(size_t size,
ysr@777:                                                        bool is_tlab) {
ysr@777:   guarantee(false, "Not using this policy feature yet.");
ysr@777:   return NULL;
ysr@777: }
ysr@777: 
ysr@777: 
ysr@777: #ifndef PRODUCT
ysr@777: bool G1CollectorPolicy::verify_young_ages() {
johnc@1829:   HeapRegion* head = _g1->young_list()->first_region();
ysr@777:   return
ysr@777:     verify_young_ages(head, _short_lived_surv_rate_group);
ysr@777:   // also call verify_young_ages on any additional surv rate groups
ysr@777: }
ysr@777: 
ysr@777: bool
ysr@777: G1CollectorPolicy::verify_young_ages(HeapRegion* head,
ysr@777:                                      SurvRateGroup *surv_rate_group) {
ysr@777:   guarantee( surv_rate_group != NULL, "pre-condition" );
ysr@777: 
ysr@777:   const char* name = surv_rate_group->name();
ysr@777:   bool ret = true;
ysr@777:   int prev_age = -1;
ysr@777: 
ysr@777:   for (HeapRegion* curr = head;
ysr@777:        curr != NULL;
ysr@777:        curr = curr->get_next_young_region()) {
ysr@777:     SurvRateGroup* group = curr->surv_rate_group();
ysr@777:     if (group == NULL && !curr->is_survivor()) {
ysr@777:       gclog_or_tty->print_cr("## %s: encountered NULL surv_rate_group", name);
ysr@777:       ret = false;
ysr@777:     }
ysr@777: 
ysr@777:     if (surv_rate_group == group) {
ysr@777:       int age = curr->age_in_surv_rate_group();
ysr@777: 
ysr@777:       if (age < 0) {
ysr@777:         gclog_or_tty->print_cr("## %s: encountered negative age", name);
ysr@777:         ret = false;
ysr@777:       }
ysr@777: 
ysr@777:       if (age <= prev_age) {
ysr@777:         gclog_or_tty->print_cr("## %s: region ages are not strictly increasing "
ysr@777:                                "(%d, %d)", name, age, prev_age);
ysr@777:         ret = false;
ysr@777:       }
ysr@777:       prev_age = age;
ysr@777:     }
ysr@777:   }
ysr@777: 
ysr@777:   return ret;
ysr@777: }
ysr@777: #endif // PRODUCT
ysr@777: 
ysr@777: void G1CollectorPolicy::record_full_collection_start() {
ysr@777:   _cur_collection_start_sec = os::elapsedTime();
ysr@777:   // Release the future to-space so that it is available for compaction into.
ysr@777:   _g1->set_full_collection();
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_full_collection_end() {
ysr@777:   // Consider this like a collection pause for the purposes of allocation
ysr@777:   // since last pause.
ysr@777:   double end_sec = os::elapsedTime();
ysr@777:   double full_gc_time_sec = end_sec - _cur_collection_start_sec;
ysr@777:   double full_gc_time_ms = full_gc_time_sec * 1000.0;
ysr@777: 
ysr@777:   _all_full_gc_times_ms->add(full_gc_time_ms);
ysr@777: 
tonyp@1030:   update_recent_gc_times(end_sec, full_gc_time_ms);
ysr@777: 
ysr@777:   _g1->clear_full_collection();
ysr@777: 
ysr@777:   // "Nuke" the heuristics that control the fully/partially young GC
ysr@777:   // transitions and make sure we start with fully young GCs after the
ysr@777:   // Full GC.
ysr@777:   set_full_young_gcs(true);
ysr@777:   _last_full_young_gc = false;
ysr@777:   _should_revert_to_full_young_gcs = false;
tonyp@1794:   clear_initiate_conc_mark_if_possible();
tonyp@1794:   clear_during_initial_mark_pause();
ysr@777:   _known_garbage_bytes = 0;
ysr@777:   _known_garbage_ratio = 0.0;
ysr@777:   _in_marking_window = false;
ysr@777:   _in_marking_window_im = false;
ysr@777: 
ysr@777:   _short_lived_surv_rate_group->start_adding_regions();
ysr@777:   // also call this on any additional surv rate groups
ysr@777: 
apetrusenko@980:   record_survivor_regions(0, NULL, NULL);
apetrusenko@980: 
ysr@777:   _prev_region_num_young   = _region_num_young;
ysr@777:   _prev_region_num_tenured = _region_num_tenured;
ysr@777: 
ysr@777:   _free_regions_at_end_of_collection = _g1->free_regions();
apetrusenko@980:   // Reset survivors SurvRateGroup.
apetrusenko@980:   _survivor_surv_rate_group->reset();
ysr@777:   calculate_young_list_min_length();
johnc@1829:   calculate_young_list_target_length();
ysr@777:  }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_before_bytes(size_t bytes) {
ysr@777:   _bytes_in_to_space_before_gc += bytes;
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_after_bytes(size_t bytes) {
ysr@777:   _bytes_in_to_space_after_gc += bytes;
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_stop_world_start() {
ysr@777:   _stop_world_start = os::elapsedTime();
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_collection_pause_start(double start_time_sec,
ysr@777:                                                       size_t start_used) {
ysr@777:   if (PrintGCDetails) {
ysr@777:     gclog_or_tty->stamp(PrintGCTimeStamps);
ysr@777:     gclog_or_tty->print("[GC pause");
ysr@777:     if (in_young_gc_mode())
ysr@777:       gclog_or_tty->print(" (%s)", full_young_gcs() ? "young" : "partial");
ysr@777:   }
ysr@777: 
ysr@777:   assert(_g1->used_regions() == _g1->recalculate_used_regions(),
ysr@777:          "sanity");
tonyp@1071:   assert(_g1->used() == _g1->recalculate_used(), "sanity");
ysr@777: 
ysr@777:   double s_w_t_ms = (start_time_sec - _stop_world_start) * 1000.0;
ysr@777:   _all_stop_world_times_ms->add(s_w_t_ms);
ysr@777:   _stop_world_start = 0.0;
ysr@777: 
ysr@777:   _cur_collection_start_sec = start_time_sec;
ysr@777:   _cur_collection_pause_used_at_start_bytes = start_used;
ysr@777:   _cur_collection_pause_used_regions_at_start = _g1->used_regions();
ysr@777:   _pending_cards = _g1->pending_card_num();
ysr@777:   _max_pending_cards = _g1->max_pending_card_num();
ysr@777: 
ysr@777:   _bytes_in_to_space_before_gc = 0;
ysr@777:   _bytes_in_to_space_after_gc = 0;
ysr@777:   _bytes_in_collection_set_before_gc = 0;
ysr@777: 
ysr@777: #ifdef DEBUG
ysr@777:   // initialise these to something well known so that we can spot
ysr@777:   // if they are not set properly
ysr@777: 
ysr@777:   for (int i = 0; i < _parallel_gc_threads; ++i) {
tonyp@1966:     _par_last_gc_worker_start_times_ms[i] = -1234.0;
tonyp@1966:     _par_last_ext_root_scan_times_ms[i] = -1234.0;
tonyp@1966:     _par_last_mark_stack_scan_times_ms[i] = -1234.0;
tonyp@1966:     _par_last_update_rs_times_ms[i] = -1234.0;
tonyp@1966:     _par_last_update_rs_processed_buffers[i] = -1234.0;
tonyp@1966:     _par_last_scan_rs_times_ms[i] = -1234.0;
tonyp@1966:     _par_last_obj_copy_times_ms[i] = -1234.0;
tonyp@1966:     _par_last_termination_times_ms[i] = -1234.0;
tonyp@1966:     _par_last_termination_attempts[i] = -1234.0;
tonyp@1966:     _par_last_gc_worker_end_times_ms[i] = -1234.0;
ysr@777:   }
ysr@777: #endif
ysr@777: 
ysr@777:   for (int i = 0; i < _aux_num; ++i) {
ysr@777:     _cur_aux_times_ms[i] = 0.0;
ysr@777:     _cur_aux_times_set[i] = false;
ysr@777:   }
ysr@777: 
ysr@777:   _satb_drain_time_set = false;
ysr@777:   _last_satb_drain_processed_buffers = -1;
ysr@777: 
ysr@777:   if (in_young_gc_mode())
ysr@777:     _last_young_gc_full = false;
ysr@777: 
ysr@777:   // do that for any other surv rate groups
ysr@777:   _short_lived_surv_rate_group->stop_adding_regions();
tonyp@1717:   _survivors_age_table.clear();
apetrusenko@980: 
ysr@777:   assert( verify_young_ages(), "region age verification" );
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_mark_closure_time(double mark_closure_time_ms) {
ysr@777:   _mark_closure_time_ms = mark_closure_time_ms;
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_concurrent_mark_init_start() {
ysr@777:   _mark_init_start_sec = os::elapsedTime();
ysr@777:   guarantee(!in_young_gc_mode(), "should not do be here in young GC mode");
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_concurrent_mark_init_end_pre(double
ysr@777:                                                    mark_init_elapsed_time_ms) {
ysr@777:   _during_marking = true;
tonyp@1794:   assert(!initiate_conc_mark_if_possible(), "we should have cleared it by now");
tonyp@1794:   clear_during_initial_mark_pause();
ysr@777:   _cur_mark_stop_world_time_ms = mark_init_elapsed_time_ms;
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_concurrent_mark_init_end() {
ysr@777:   double end_time_sec = os::elapsedTime();
ysr@777:   double elapsed_time_ms = (end_time_sec - _mark_init_start_sec) * 1000.0;
ysr@777:   _concurrent_mark_init_times_ms->add(elapsed_time_ms);
ysr@777:   record_concurrent_mark_init_end_pre(elapsed_time_ms);
ysr@777: 
ysr@777:   _mmu_tracker->add_pause(_mark_init_start_sec, end_time_sec, true);
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_concurrent_mark_remark_start() {
ysr@777:   _mark_remark_start_sec = os::elapsedTime();
ysr@777:   _during_marking = false;
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_concurrent_mark_remark_end() {
ysr@777:   double end_time_sec = os::elapsedTime();
ysr@777:   double elapsed_time_ms = (end_time_sec - _mark_remark_start_sec)*1000.0;
ysr@777:   _concurrent_mark_remark_times_ms->add(elapsed_time_ms);
ysr@777:   _cur_mark_stop_world_time_ms += elapsed_time_ms;
ysr@777:   _prev_collection_pause_end_ms += elapsed_time_ms;
ysr@777: 
ysr@777:   _mmu_tracker->add_pause(_mark_remark_start_sec, end_time_sec, true);
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_concurrent_mark_cleanup_start() {
ysr@777:   _mark_cleanup_start_sec = os::elapsedTime();
ysr@777: }
ysr@777: 
ysr@777: void
ysr@777: G1CollectorPolicy::record_concurrent_mark_cleanup_end(size_t freed_bytes,
ysr@777:                                                       size_t max_live_bytes) {
ysr@777:   record_concurrent_mark_cleanup_end_work1(freed_bytes, max_live_bytes);
ysr@777:   record_concurrent_mark_cleanup_end_work2();
ysr@777: }
ysr@777: 
ysr@777: void
ysr@777: G1CollectorPolicy::
ysr@777: record_concurrent_mark_cleanup_end_work1(size_t freed_bytes,
ysr@777:                                          size_t max_live_bytes) {
ysr@777:   if (_n_marks < 2) _n_marks++;
ysr@777:   if (G1PolicyVerbose > 0)
ysr@777:     gclog_or_tty->print_cr("At end of marking, max_live is " SIZE_FORMAT " MB "
ysr@777:                            " (of " SIZE_FORMAT " MB heap).",
ysr@777:                            max_live_bytes/M, _g1->capacity()/M);
ysr@777: }
ysr@777: 
ysr@777: // The important thing about this is that it includes "os::elapsedTime".
ysr@777: void G1CollectorPolicy::record_concurrent_mark_cleanup_end_work2() {
ysr@777:   double end_time_sec = os::elapsedTime();
ysr@777:   double elapsed_time_ms = (end_time_sec - _mark_cleanup_start_sec)*1000.0;
ysr@777:   _concurrent_mark_cleanup_times_ms->add(elapsed_time_ms);
ysr@777:   _cur_mark_stop_world_time_ms += elapsed_time_ms;
ysr@777:   _prev_collection_pause_end_ms += elapsed_time_ms;
ysr@777: 
ysr@777:   _mmu_tracker->add_pause(_mark_cleanup_start_sec, end_time_sec, true);
ysr@777: 
ysr@777:   _num_markings++;
ysr@777: 
ysr@777:   // We did a marking, so reset the "since_last_mark" variables.
ysr@777:   double considerConcMarkCost = 1.0;
ysr@777:   // If there are available processors, concurrent activity is free...
ysr@777:   if (Threads::number_of_non_daemon_threads() * 2 <
ysr@777:       os::active_processor_count()) {
ysr@777:     considerConcMarkCost = 0.0;
ysr@777:   }
ysr@777:   _n_pauses_at_mark_end = _n_pauses;
ysr@777:   _n_marks_since_last_pause++;
ysr@777: }
ysr@777: 
ysr@777: void
ysr@777: G1CollectorPolicy::record_concurrent_mark_cleanup_completed() {
ysr@777:   if (in_young_gc_mode()) {
ysr@777:     _should_revert_to_full_young_gcs = false;
ysr@777:     _last_full_young_gc = true;
ysr@777:     _in_marking_window = false;
ysr@777:     if (adaptive_young_list_length())
johnc@1829:       calculate_young_list_target_length();
ysr@777:   }
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_concurrent_pause() {
ysr@777:   if (_stop_world_start > 0.0) {
ysr@777:     double yield_ms = (os::elapsedTime() - _stop_world_start) * 1000.0;
ysr@777:     _all_yield_times_ms->add(yield_ms);
ysr@777:   }
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_concurrent_pause_end() {
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_collection_pause_end_CH_strong_roots() {
ysr@777:   _cur_CH_strong_roots_end_sec = os::elapsedTime();
ysr@777:   _cur_CH_strong_roots_dur_ms =
ysr@777:     (_cur_CH_strong_roots_end_sec - _cur_collection_start_sec) * 1000.0;
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::record_collection_pause_end_G1_strong_roots() {
ysr@777:   _cur_G1_strong_roots_end_sec = os::elapsedTime();
ysr@777:   _cur_G1_strong_roots_dur_ms =
ysr@777:     (_cur_G1_strong_roots_end_sec - _cur_CH_strong_roots_end_sec) * 1000.0;
ysr@777: }
ysr@777: 
ysr@777: template<class T>
ysr@777: T sum_of(T* sum_arr, int start, int n, int N) {
ysr@777:   T sum = (T)0;
ysr@777:   for (int i = 0; i < n; i++) {
ysr@777:     int j = (start + i) % N;
ysr@777:     sum += sum_arr[j];
ysr@777:   }
ysr@777:   return sum;
ysr@777: }
ysr@777: 
tonyp@1966: void G1CollectorPolicy::print_par_stats(int level,
tonyp@1966:                                         const char* str,
tonyp@1966:                                         double* data,
ysr@777:                                          bool summary) {
ysr@777:   double min = data[0], max = data[0];
ysr@777:   double total = 0.0;
ysr@777:   int j;
ysr@777:   for (j = 0; j < level; ++j)
ysr@777:     gclog_or_tty->print("   ");
ysr@777:   gclog_or_tty->print("[%s (ms):", str);
ysr@777:   for (uint i = 0; i < ParallelGCThreads; ++i) {
ysr@777:     double val = data[i];
ysr@777:     if (val < min)
ysr@777:       min = val;
ysr@777:     if (val > max)
ysr@777:       max = val;
ysr@777:     total += val;
ysr@777:     gclog_or_tty->print("  %3.1lf", val);
ysr@777:   }
ysr@777:   if (summary) {
ysr@777:     gclog_or_tty->print_cr("");
ysr@777:     double avg = total / (double) ParallelGCThreads;
ysr@777:     gclog_or_tty->print(" ");
ysr@777:     for (j = 0; j < level; ++j)
ysr@777:       gclog_or_tty->print("   ");
ysr@777:     gclog_or_tty->print("Avg: %5.1lf, Min: %5.1lf, Max: %5.1lf",
ysr@777:                         avg, min, max);
ysr@777:   }
ysr@777:   gclog_or_tty->print_cr("]");
ysr@777: }
ysr@777: 
tonyp@1966: void G1CollectorPolicy::print_par_sizes(int level,
tonyp@1966:                                         const char* str,
tonyp@1966:                                         double* data,
tonyp@1966:                                         bool summary) {
ysr@777:   double min = data[0], max = data[0];
ysr@777:   double total = 0.0;
ysr@777:   int j;
ysr@777:   for (j = 0; j < level; ++j)
ysr@777:     gclog_or_tty->print("   ");
ysr@777:   gclog_or_tty->print("[%s :", str);
ysr@777:   for (uint i = 0; i < ParallelGCThreads; ++i) {
ysr@777:     double val = data[i];
ysr@777:     if (val < min)
ysr@777:       min = val;
ysr@777:     if (val > max)
ysr@777:       max = val;
ysr@777:     total += val;
ysr@777:     gclog_or_tty->print(" %d", (int) val);
ysr@777:   }
ysr@777:   if (summary) {
ysr@777:     gclog_or_tty->print_cr("");
ysr@777:     double avg = total / (double) ParallelGCThreads;
ysr@777:     gclog_or_tty->print(" ");
ysr@777:     for (j = 0; j < level; ++j)
ysr@777:       gclog_or_tty->print("   ");
ysr@777:     gclog_or_tty->print("Sum: %d, Avg: %d, Min: %d, Max: %d",
ysr@777:                (int)total, (int)avg, (int)min, (int)max);
ysr@777:   }
ysr@777:   gclog_or_tty->print_cr("]");
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::print_stats (int level,
ysr@777:                                      const char* str,
ysr@777:                                      double value) {
ysr@777:   for (int j = 0; j < level; ++j)
ysr@777:     gclog_or_tty->print("   ");
ysr@777:   gclog_or_tty->print_cr("[%s: %5.1lf ms]", str, value);
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::print_stats (int level,
ysr@777:                                      const char* str,
ysr@777:                                      int value) {
ysr@777:   for (int j = 0; j < level; ++j)
ysr@777:     gclog_or_tty->print("   ");
ysr@777:   gclog_or_tty->print_cr("[%s: %d]", str, value);
ysr@777: }
ysr@777: 
ysr@777: double G1CollectorPolicy::avg_value (double* data) {
ysr@777:   if (ParallelGCThreads > 0) {
ysr@777:     double ret = 0.0;
ysr@777:     for (uint i = 0; i < ParallelGCThreads; ++i)
ysr@777:       ret += data[i];
ysr@777:     return ret / (double) ParallelGCThreads;
ysr@777:   } else {
ysr@777:     return data[0];
ysr@777:   }
ysr@777: }
ysr@777: 
ysr@777: double G1CollectorPolicy::max_value (double* data) {
ysr@777:   if (ParallelGCThreads > 0) {
ysr@777:     double ret = data[0];
ysr@777:     for (uint i = 1; i < ParallelGCThreads; ++i)
ysr@777:       if (data[i] > ret)
ysr@777:         ret = data[i];
ysr@777:     return ret;
ysr@777:   } else {
ysr@777:     return data[0];
ysr@777:   }
ysr@777: }
ysr@777: 
ysr@777: double G1CollectorPolicy::sum_of_values (double* data) {
ysr@777:   if (ParallelGCThreads > 0) {
ysr@777:     double sum = 0.0;
ysr@777:     for (uint i = 0; i < ParallelGCThreads; i++)
ysr@777:       sum += data[i];
ysr@777:     return sum;
ysr@777:   } else {
ysr@777:     return data[0];
ysr@777:   }
ysr@777: }
ysr@777: 
ysr@777: double G1CollectorPolicy::max_sum (double* data1,
ysr@777:                                    double* data2) {
ysr@777:   double ret = data1[0] + data2[0];
ysr@777: 
ysr@777:   if (ParallelGCThreads > 0) {
ysr@777:     for (uint i = 1; i < ParallelGCThreads; ++i) {
ysr@777:       double data = data1[i] + data2[i];
ysr@777:       if (data > ret)
ysr@777:         ret = data;
ysr@777:     }
ysr@777:   }
ysr@777:   return ret;
ysr@777: }
ysr@777: 
ysr@777: // Anything below that is considered to be zero
ysr@777: #define MIN_TIMER_GRANULARITY 0.0000001
ysr@777: 
apetrusenko@1112: void G1CollectorPolicy::record_collection_pause_end(bool abandoned) {
ysr@777:   double end_time_sec = os::elapsedTime();
ysr@777:   double elapsed_ms = _last_pause_time_ms;
ysr@777:   bool parallel = ParallelGCThreads > 0;
ysr@777:   double evac_ms = (end_time_sec - _cur_G1_strong_roots_end_sec) * 1000.0;
ysr@777:   size_t rs_size =
ysr@777:     _cur_collection_pause_used_regions_at_start - collection_set_size();
ysr@777:   size_t cur_used_bytes = _g1->used();
ysr@777:   assert(cur_used_bytes == _g1->recalculate_used(), "It should!");
ysr@777:   bool last_pause_included_initial_mark = false;
tonyp@1030:   bool update_stats = !abandoned && !_g1->evacuation_failed();
ysr@777: 
ysr@777: #ifndef PRODUCT
ysr@777:   if (G1YoungSurvRateVerbose) {
ysr@777:     gclog_or_tty->print_cr("");
ysr@777:     _short_lived_surv_rate_group->print();
ysr@777:     // do that for any other surv rate groups too
ysr@777:   }
ysr@777: #endif // PRODUCT
ysr@777: 
ysr@777:   if (in_young_gc_mode()) {
tonyp@1794:     last_pause_included_initial_mark = during_initial_mark_pause();
ysr@777:     if (last_pause_included_initial_mark)
ysr@777:       record_concurrent_mark_init_end_pre(0.0);
ysr@777: 
ysr@777:     size_t min_used_targ =
tonyp@1718:       (_g1->capacity() / 100) * InitiatingHeapOccupancyPercent;
ysr@777: 
tonyp@1794: 
tonyp@1794:     if (!_g1->mark_in_progress() && !_last_full_young_gc) {
tonyp@1794:       assert(!last_pause_included_initial_mark, "invariant");
tonyp@1794:       if (cur_used_bytes > min_used_targ &&
tonyp@1794:           cur_used_bytes > _prev_collection_pause_used_at_end_bytes) {
tonyp@1794:         assert(!during_initial_mark_pause(), "we should not see this here");
tonyp@1794: 
tonyp@1794:         // Note: this might have already been set, if during the last
tonyp@1794:         // pause we decided to start a cycle but at the beginning of
tonyp@1794:         // this pause we decided to postpone it. That's OK.
tonyp@1794:         set_initiate_conc_mark_if_possible();
ysr@777:       }
ysr@777:     }
ysr@777: 
ysr@777:     _prev_collection_pause_used_at_end_bytes = cur_used_bytes;
ysr@777:   }
ysr@777: 
ysr@777:   _mmu_tracker->add_pause(end_time_sec - elapsed_ms/1000.0,
ysr@777:                           end_time_sec, false);
ysr@777: 
ysr@777:   guarantee(_cur_collection_pause_used_regions_at_start >=
ysr@777:             collection_set_size(),
ysr@777:             "Negative RS size?");
ysr@777: 
ysr@777:   // This assert is exempted when we're doing parallel collection pauses,
ysr@777:   // because the fragmentation caused by the parallel GC allocation buffers
ysr@777:   // can lead to more memory being used during collection than was used
ysr@777:   // before. Best leave this out until the fragmentation problem is fixed.
ysr@777:   // Pauses in which evacuation failed can also lead to negative
ysr@777:   // collections, since no space is reclaimed from a region containing an
ysr@777:   // object whose evacuation failed.
ysr@777:   // Further, we're now always doing parallel collection.  But I'm still
ysr@777:   // leaving this here as a placeholder for a more precise assertion later.
ysr@777:   // (DLD, 10/05.)
ysr@777:   assert((true || parallel) // Always using GC LABs now.
ysr@777:          || _g1->evacuation_failed()
ysr@777:          || _cur_collection_pause_used_at_start_bytes >= cur_used_bytes,
ysr@777:          "Negative collection");
ysr@777: 
ysr@777:   size_t freed_bytes =
ysr@777:     _cur_collection_pause_used_at_start_bytes - cur_used_bytes;
ysr@777:   size_t surviving_bytes = _collection_set_bytes_used_before - freed_bytes;
johnc@1829: 
ysr@777:   double survival_fraction =
ysr@777:     (double)surviving_bytes/
ysr@777:     (double)_collection_set_bytes_used_before;
ysr@777: 
ysr@777:   _n_pauses++;
ysr@777: 
tonyp@1030:   if (update_stats) {
ysr@777:     _recent_CH_strong_roots_times_ms->add(_cur_CH_strong_roots_dur_ms);
ysr@777:     _recent_G1_strong_roots_times_ms->add(_cur_G1_strong_roots_dur_ms);
ysr@777:     _recent_evac_times_ms->add(evac_ms);
ysr@777:     _recent_pause_times_ms->add(elapsed_ms);
ysr@777: 
ysr@777:     _recent_rs_sizes->add(rs_size);
ysr@777: 
ysr@777:     // We exempt parallel collection from this check because Alloc Buffer
ysr@777:     // fragmentation can produce negative collections.  Same with evac
ysr@777:     // failure.
ysr@777:     // Further, we're now always doing parallel collection.  But I'm still
ysr@777:     // leaving this here as a placeholder for a more precise assertion later.
ysr@777:     // (DLD, 10/05.
ysr@777:     assert((true || parallel)
ysr@777:            || _g1->evacuation_failed()
ysr@777:            || surviving_bytes <= _collection_set_bytes_used_before,
ysr@777:            "Or else negative collection!");
ysr@777:     _recent_CS_bytes_used_before->add(_collection_set_bytes_used_before);
ysr@777:     _recent_CS_bytes_surviving->add(surviving_bytes);
ysr@777: 
ysr@777:     // this is where we update the allocation rate of the application
ysr@777:     double app_time_ms =
ysr@777:       (_cur_collection_start_sec * 1000.0 - _prev_collection_pause_end_ms);
ysr@777:     if (app_time_ms < MIN_TIMER_GRANULARITY) {
ysr@777:       // This usually happens due to the timer not having the required
ysr@777:       // granularity. Some Linuxes are the usual culprits.
ysr@777:       // We'll just set it to something (arbitrarily) small.
ysr@777:       app_time_ms = 1.0;
ysr@777:     }
ysr@777:     size_t regions_allocated =
ysr@777:       (_region_num_young - _prev_region_num_young) +
ysr@777:       (_region_num_tenured - _prev_region_num_tenured);
ysr@777:     double alloc_rate_ms = (double) regions_allocated / app_time_ms;
ysr@777:     _alloc_rate_ms_seq->add(alloc_rate_ms);
ysr@777:     _prev_region_num_young   = _region_num_young;
ysr@777:     _prev_region_num_tenured = _region_num_tenured;
ysr@777: 
ysr@777:     double interval_ms =
ysr@777:       (end_time_sec - _recent_prev_end_times_for_all_gcs_sec->oldest()) * 1000.0;
ysr@777:     update_recent_gc_times(end_time_sec, elapsed_ms);
ysr@777:     _recent_avg_pause_time_ratio = _recent_gc_times_ms->sum()/interval_ms;
ysr@1521:     if (recent_avg_pause_time_ratio() < 0.0 ||
ysr@1521:         (recent_avg_pause_time_ratio() - 1.0 > 0.0)) {
ysr@1521: #ifndef PRODUCT
ysr@1521:       // Dump info to allow post-facto debugging
ysr@1521:       gclog_or_tty->print_cr("recent_avg_pause_time_ratio() out of bounds");
ysr@1521:       gclog_or_tty->print_cr("-------------------------------------------");
ysr@1521:       gclog_or_tty->print_cr("Recent GC Times (ms):");
ysr@1521:       _recent_gc_times_ms->dump();
ysr@1521:       gclog_or_tty->print_cr("(End Time=%3.3f) Recent GC End Times (s):", end_time_sec);
ysr@1521:       _recent_prev_end_times_for_all_gcs_sec->dump();
ysr@1521:       gclog_or_tty->print_cr("GC = %3.3f, Interval = %3.3f, Ratio = %3.3f",
ysr@1521:                              _recent_gc_times_ms->sum(), interval_ms, recent_avg_pause_time_ratio());
ysr@1522:       // In debug mode, terminate the JVM if the user wants to debug at this point.
ysr@1522:       assert(!G1FailOnFPError, "Debugging data for CR 6898948 has been dumped above");
ysr@1522: #endif  // !PRODUCT
ysr@1522:       // Clip ratio between 0.0 and 1.0, and continue. This will be fixed in
ysr@1522:       // CR 6902692 by redoing the manner in which the ratio is incrementally computed.
ysr@1521:       if (_recent_avg_pause_time_ratio < 0.0) {
ysr@1521:         _recent_avg_pause_time_ratio = 0.0;
ysr@1521:       } else {
ysr@1521:         assert(_recent_avg_pause_time_ratio - 1.0 > 0.0, "Ctl-point invariant");
ysr@1521:         _recent_avg_pause_time_ratio = 1.0;
ysr@1521:       }
ysr@1521:     }
ysr@777:   }
ysr@777: 
ysr@777:   if (G1PolicyVerbose > 1) {
ysr@777:     gclog_or_tty->print_cr("   Recording collection pause(%d)", _n_pauses);
ysr@777:   }
ysr@777: 
ysr@777:   PauseSummary* summary;
apetrusenko@1112:   if (abandoned) {
apetrusenko@1112:     summary = _abandoned_summary;
apetrusenko@1112:   } else {
apetrusenko@1112:     summary = _summary;
ysr@777:   }
ysr@777: 
ysr@777:   double ext_root_scan_time = avg_value(_par_last_ext_root_scan_times_ms);
ysr@777:   double mark_stack_scan_time = avg_value(_par_last_mark_stack_scan_times_ms);
ysr@777:   double update_rs_time = avg_value(_par_last_update_rs_times_ms);
ysr@777:   double update_rs_processed_buffers =
ysr@777:     sum_of_values(_par_last_update_rs_processed_buffers);
ysr@777:   double scan_rs_time = avg_value(_par_last_scan_rs_times_ms);
ysr@777:   double obj_copy_time = avg_value(_par_last_obj_copy_times_ms);
ysr@777:   double termination_time = avg_value(_par_last_termination_times_ms);
ysr@777: 
tonyp@1083:   double parallel_other_time = _cur_collection_par_time_ms -
tonyp@1083:     (update_rs_time + ext_root_scan_time + mark_stack_scan_time +
johnc@1829:      scan_rs_time + obj_copy_time + termination_time);
tonyp@1030:   if (update_stats) {
ysr@777:     MainBodySummary* body_summary = summary->main_body_summary();
ysr@777:     guarantee(body_summary != NULL, "should not be null!");
ysr@777: 
ysr@777:     if (_satb_drain_time_set)
ysr@777:       body_summary->record_satb_drain_time_ms(_cur_satb_drain_time_ms);
ysr@777:     else
ysr@777:       body_summary->record_satb_drain_time_ms(0.0);
ysr@777:     body_summary->record_ext_root_scan_time_ms(ext_root_scan_time);
ysr@777:     body_summary->record_mark_stack_scan_time_ms(mark_stack_scan_time);
ysr@777:     body_summary->record_update_rs_time_ms(update_rs_time);
ysr@777:     body_summary->record_scan_rs_time_ms(scan_rs_time);
ysr@777:     body_summary->record_obj_copy_time_ms(obj_copy_time);
ysr@777:     if (parallel) {
ysr@777:       body_summary->record_parallel_time_ms(_cur_collection_par_time_ms);
ysr@777:       body_summary->record_clear_ct_time_ms(_cur_clear_ct_time_ms);
ysr@777:       body_summary->record_termination_time_ms(termination_time);
ysr@777:       body_summary->record_parallel_other_time_ms(parallel_other_time);
ysr@777:     }
ysr@777:     body_summary->record_mark_closure_time_ms(_mark_closure_time_ms);
ysr@777:   }
ysr@777: 
ysr@777:   if (G1PolicyVerbose > 1) {
ysr@777:     gclog_or_tty->print_cr("      ET: %10.6f ms           (avg: %10.6f ms)\n"
ysr@777:                            "        CH Strong: %10.6f ms    (avg: %10.6f ms)\n"
ysr@777:                            "        G1 Strong: %10.6f ms    (avg: %10.6f ms)\n"
ysr@777:                            "        Evac:      %10.6f ms    (avg: %10.6f ms)\n"
ysr@777:                            "       ET-RS:  %10.6f ms      (avg: %10.6f ms)\n"
ysr@777:                            "      |RS|: " SIZE_FORMAT,
ysr@777:                            elapsed_ms, recent_avg_time_for_pauses_ms(),
ysr@777:                            _cur_CH_strong_roots_dur_ms, recent_avg_time_for_CH_strong_ms(),
ysr@777:                            _cur_G1_strong_roots_dur_ms, recent_avg_time_for_G1_strong_ms(),
ysr@777:                            evac_ms, recent_avg_time_for_evac_ms(),
ysr@777:                            scan_rs_time,
ysr@777:                            recent_avg_time_for_pauses_ms() -
ysr@777:                            recent_avg_time_for_G1_strong_ms(),
ysr@777:                            rs_size);
ysr@777: 
ysr@777:     gclog_or_tty->print_cr("       Used at start: " SIZE_FORMAT"K"
ysr@777:                            "       At end " SIZE_FORMAT "K\n"
ysr@777:                            "       garbage      : " SIZE_FORMAT "K"
ysr@777:                            "       of     " SIZE_FORMAT "K\n"
ysr@777:                            "       survival     : %6.2f%%  (%6.2f%% avg)",
ysr@777:                            _cur_collection_pause_used_at_start_bytes/K,
ysr@777:                            _g1->used()/K, freed_bytes/K,
ysr@777:                            _collection_set_bytes_used_before/K,
ysr@777:                            survival_fraction*100.0,
ysr@777:                            recent_avg_survival_fraction()*100.0);
ysr@777:     gclog_or_tty->print_cr("       Recent %% gc pause time: %6.2f",
ysr@777:                            recent_avg_pause_time_ratio() * 100.0);
ysr@777:   }
ysr@777: 
ysr@777:   double other_time_ms = elapsed_ms;
ysr@777: 
ysr@777:   if (!abandoned) {
ysr@777:     if (_satb_drain_time_set)
ysr@777:       other_time_ms -= _cur_satb_drain_time_ms;
ysr@777: 
ysr@777:     if (parallel)
ysr@777:       other_time_ms -= _cur_collection_par_time_ms + _cur_clear_ct_time_ms;
ysr@777:     else
ysr@777:       other_time_ms -=
ysr@777:         update_rs_time +
johnc@1829:         ext_root_scan_time + mark_stack_scan_time +
ysr@777:         scan_rs_time + obj_copy_time;
ysr@777:   }
ysr@777: 
ysr@777:   if (PrintGCDetails) {
ysr@777:     gclog_or_tty->print_cr("%s%s, %1.8lf secs]",
apetrusenko@1112:                            abandoned ? " (abandoned)" : "",
ysr@777:                            (last_pause_included_initial_mark) ? " (initial-mark)" : "",
ysr@777:                            elapsed_ms / 1000.0);
ysr@777: 
ysr@777:     if (!abandoned) {
apetrusenko@1112:       if (_satb_drain_time_set) {
ysr@777:         print_stats(1, "SATB Drain Time", _cur_satb_drain_time_ms);
apetrusenko@1112:       }
apetrusenko@1112:       if (_last_satb_drain_processed_buffers >= 0) {
ysr@777:         print_stats(2, "Processed Buffers", _last_satb_drain_processed_buffers);
apetrusenko@1112:       }
apetrusenko@1112:       if (parallel) {
apetrusenko@1112:         print_stats(1, "Parallel Time", _cur_collection_par_time_ms);
tonyp@1966:         print_par_stats(2, "GC Worker Start Time",
tonyp@1966:                         _par_last_gc_worker_start_times_ms, false);
apetrusenko@1112:         print_par_stats(2, "Update RS", _par_last_update_rs_times_ms);
tonyp@1966:         print_par_sizes(3, "Processed Buffers",
tonyp@1966:                         _par_last_update_rs_processed_buffers, true);
tonyp@1966:         print_par_stats(2, "Ext Root Scanning",
tonyp@1966:                         _par_last_ext_root_scan_times_ms);
tonyp@1966:         print_par_stats(2, "Mark Stack Scanning",
tonyp@1966:                         _par_last_mark_stack_scan_times_ms);
ysr@777:         print_par_stats(2, "Scan RS", _par_last_scan_rs_times_ms);
ysr@777:         print_par_stats(2, "Object Copy", _par_last_obj_copy_times_ms);
ysr@777:         print_par_stats(2, "Termination", _par_last_termination_times_ms);
tonyp@1966:         print_par_sizes(3, "Termination Attempts",
tonyp@1966:                         _par_last_termination_attempts, true);
tonyp@1966:         print_par_stats(2, "GC Worker End Time",
tonyp@1966:                         _par_last_gc_worker_end_times_ms, false);
ysr@777:         print_stats(2, "Other", parallel_other_time);
ysr@777:         print_stats(1, "Clear CT", _cur_clear_ct_time_ms);
apetrusenko@1112:       } else {
apetrusenko@1112:         print_stats(1, "Update RS", update_rs_time);
iveresov@1229:         print_stats(2, "Processed Buffers",
iveresov@1229:                     (int)update_rs_processed_buffers);
ysr@777:         print_stats(1, "Ext Root Scanning", ext_root_scan_time);
ysr@777:         print_stats(1, "Mark Stack Scanning", mark_stack_scan_time);
ysr@777:         print_stats(1, "Scan RS", scan_rs_time);
ysr@777:         print_stats(1, "Object Copying", obj_copy_time);
ysr@777:       }
ysr@777:     }
johnc@1325: #ifndef PRODUCT
johnc@1325:     print_stats(1, "Cur Clear CC", _cur_clear_cc_time_ms);
johnc@1325:     print_stats(1, "Cum Clear CC", _cum_clear_cc_time_ms);
johnc@1325:     print_stats(1, "Min Clear CC", _min_clear_cc_time_ms);
johnc@1325:     print_stats(1, "Max Clear CC", _max_clear_cc_time_ms);
johnc@1325:     if (_num_cc_clears > 0) {
johnc@1325:       print_stats(1, "Avg Clear CC", _cum_clear_cc_time_ms / ((double)_num_cc_clears));
johnc@1325:     }
johnc@1325: #endif
ysr@777:     print_stats(1, "Other", other_time_ms);
johnc@1829:     print_stats(2, "Choose CSet", _recorded_young_cset_choice_time_ms);
johnc@1829: 
ysr@777:     for (int i = 0; i < _aux_num; ++i) {
ysr@777:       if (_cur_aux_times_set[i]) {
ysr@777:         char buffer[96];
ysr@777:         sprintf(buffer, "Aux%d", i);
ysr@777:         print_stats(1, buffer, _cur_aux_times_ms[i]);
ysr@777:       }
ysr@777:     }
ysr@777:   }
ysr@777:   if (PrintGCDetails)
ysr@777:     gclog_or_tty->print("   [");
ysr@777:   if (PrintGC || PrintGCDetails)
ysr@777:     _g1->print_size_transition(gclog_or_tty,
ysr@777:                                _cur_collection_pause_used_at_start_bytes,
ysr@777:                                _g1->used(), _g1->capacity());
ysr@777:   if (PrintGCDetails)
ysr@777:     gclog_or_tty->print_cr("]");
ysr@777: 
ysr@777:   _all_pause_times_ms->add(elapsed_ms);
tonyp@1083:   if (update_stats) {
tonyp@1083:     summary->record_total_time_ms(elapsed_ms);
tonyp@1083:     summary->record_other_time_ms(other_time_ms);
tonyp@1083:   }
ysr@777:   for (int i = 0; i < _aux_num; ++i)
ysr@777:     if (_cur_aux_times_set[i])
ysr@777:       _all_aux_times_ms[i].add(_cur_aux_times_ms[i]);
ysr@777: 
ysr@777:   // Reset marks-between-pauses counter.
ysr@777:   _n_marks_since_last_pause = 0;
ysr@777: 
ysr@777:   // Update the efficiency-since-mark vars.
ysr@777:   double proc_ms = elapsed_ms * (double) _parallel_gc_threads;
ysr@777:   if (elapsed_ms < MIN_TIMER_GRANULARITY) {
ysr@777:     // This usually happens due to the timer not having the required
ysr@777:     // granularity. Some Linuxes are the usual culprits.
ysr@777:     // We'll just set it to something (arbitrarily) small.
ysr@777:     proc_ms = 1.0;
ysr@777:   }
ysr@777:   double cur_efficiency = (double) freed_bytes / proc_ms;
ysr@777: 
ysr@777:   bool new_in_marking_window = _in_marking_window;
ysr@777:   bool new_in_marking_window_im = false;
tonyp@1794:   if (during_initial_mark_pause()) {
ysr@777:     new_in_marking_window = true;
ysr@777:     new_in_marking_window_im = true;
ysr@777:   }
ysr@777: 
ysr@777:   if (in_young_gc_mode()) {
ysr@777:     if (_last_full_young_gc) {
ysr@777:       set_full_young_gcs(false);
ysr@777:       _last_full_young_gc = false;
ysr@777:     }
ysr@777: 
ysr@777:     if ( !_last_young_gc_full ) {
ysr@777:       if ( _should_revert_to_full_young_gcs ||
ysr@777:            _known_garbage_ratio < 0.05 ||
ysr@777:            (adaptive_young_list_length() &&
ysr@777:            (get_gc_eff_factor() * cur_efficiency < predict_young_gc_eff())) ) {
ysr@777:         set_full_young_gcs(true);
ysr@777:       }
ysr@777:     }
ysr@777:     _should_revert_to_full_young_gcs = false;
ysr@777: 
ysr@777:     if (_last_young_gc_full && !_during_marking)
ysr@777:       _young_gc_eff_seq->add(cur_efficiency);
ysr@777:   }
ysr@777: 
ysr@777:   _short_lived_surv_rate_group->start_adding_regions();
ysr@777:   // do that for any other surv rate groupsx
ysr@777: 
ysr@777:   // <NEW PREDICTION>
ysr@777: 
apetrusenko@1112:   if (update_stats) {
ysr@777:     double pause_time_ms = elapsed_ms;
ysr@777: 
ysr@777:     size_t diff = 0;
ysr@777:     if (_max_pending_cards >= _pending_cards)
ysr@777:       diff = _max_pending_cards - _pending_cards;
ysr@777:     _pending_card_diff_seq->add((double) diff);
ysr@777: 
ysr@777:     double cost_per_card_ms = 0.0;
ysr@777:     if (_pending_cards > 0) {
ysr@777:       cost_per_card_ms = update_rs_time / (double) _pending_cards;
ysr@777:       _cost_per_card_ms_seq->add(cost_per_card_ms);
ysr@777:     }
ysr@777: 
ysr@777:     size_t cards_scanned = _g1->cards_scanned();
ysr@777: 
ysr@777:     double cost_per_entry_ms = 0.0;
ysr@777:     if (cards_scanned > 10) {
ysr@777:       cost_per_entry_ms = scan_rs_time / (double) cards_scanned;
ysr@777:       if (_last_young_gc_full)
ysr@777:         _cost_per_entry_ms_seq->add(cost_per_entry_ms);
ysr@777:       else
ysr@777:         _partially_young_cost_per_entry_ms_seq->add(cost_per_entry_ms);
ysr@777:     }
ysr@777: 
ysr@777:     if (_max_rs_lengths > 0) {
ysr@777:       double cards_per_entry_ratio =
ysr@777:         (double) cards_scanned / (double) _max_rs_lengths;
ysr@777:       if (_last_young_gc_full)
ysr@777:         _fully_young_cards_per_entry_ratio_seq->add(cards_per_entry_ratio);
ysr@777:       else
ysr@777:         _partially_young_cards_per_entry_ratio_seq->add(cards_per_entry_ratio);
ysr@777:     }
ysr@777: 
ysr@777:     size_t rs_length_diff = _max_rs_lengths - _recorded_rs_lengths;
ysr@777:     if (rs_length_diff >= 0)
ysr@777:       _rs_length_diff_seq->add((double) rs_length_diff);
ysr@777: 
ysr@777:     size_t copied_bytes = surviving_bytes;
ysr@777:     double cost_per_byte_ms = 0.0;
ysr@777:     if (copied_bytes > 0) {
ysr@777:       cost_per_byte_ms = obj_copy_time / (double) copied_bytes;
ysr@777:       if (_in_marking_window)
ysr@777:         _cost_per_byte_ms_during_cm_seq->add(cost_per_byte_ms);
ysr@777:       else
ysr@777:         _cost_per_byte_ms_seq->add(cost_per_byte_ms);
ysr@777:     }
ysr@777: 
ysr@777:     double all_other_time_ms = pause_time_ms -
johnc@1829:       (update_rs_time + scan_rs_time + obj_copy_time +
ysr@777:        _mark_closure_time_ms + termination_time);
ysr@777: 
ysr@777:     double young_other_time_ms = 0.0;
ysr@777:     if (_recorded_young_regions > 0) {
ysr@777:       young_other_time_ms =
ysr@777:         _recorded_young_cset_choice_time_ms +
ysr@777:         _recorded_young_free_cset_time_ms;
ysr@777:       _young_other_cost_per_region_ms_seq->add(young_other_time_ms /
ysr@777:                                              (double) _recorded_young_regions);
ysr@777:     }
ysr@777:     double non_young_other_time_ms = 0.0;
ysr@777:     if (_recorded_non_young_regions > 0) {
ysr@777:       non_young_other_time_ms =
ysr@777:         _recorded_non_young_cset_choice_time_ms +
ysr@777:         _recorded_non_young_free_cset_time_ms;
ysr@777: 
ysr@777:       _non_young_other_cost_per_region_ms_seq->add(non_young_other_time_ms /
ysr@777:                                          (double) _recorded_non_young_regions);
ysr@777:     }
ysr@777: 
ysr@777:     double constant_other_time_ms = all_other_time_ms -
ysr@777:       (young_other_time_ms + non_young_other_time_ms);
ysr@777:     _constant_other_time_ms_seq->add(constant_other_time_ms);
ysr@777: 
ysr@777:     double survival_ratio = 0.0;
ysr@777:     if (_bytes_in_collection_set_before_gc > 0) {
ysr@777:       survival_ratio = (double) bytes_in_to_space_during_gc() /
ysr@777:         (double) _bytes_in_collection_set_before_gc;
ysr@777:     }
ysr@777: 
ysr@777:     _pending_cards_seq->add((double) _pending_cards);
ysr@777:     _scanned_cards_seq->add((double) cards_scanned);
ysr@777:     _rs_lengths_seq->add((double) _max_rs_lengths);
ysr@777: 
ysr@777:     double expensive_region_limit_ms =
johnc@1186:       (double) MaxGCPauseMillis - predict_constant_other_time_ms();
ysr@777:     if (expensive_region_limit_ms < 0.0) {
ysr@777:       // this means that the other time was predicted to be longer than
ysr@777:       // than the max pause time
johnc@1186:       expensive_region_limit_ms = (double) MaxGCPauseMillis;
ysr@777:     }
ysr@777:     _expensive_region_limit_ms = expensive_region_limit_ms;
ysr@777: 
ysr@777:     if (PREDICTIONS_VERBOSE) {
ysr@777:       gclog_or_tty->print_cr("");
ysr@777:       gclog_or_tty->print_cr("PREDICTIONS %1.4lf %d "
johnc@1829:                     "REGIONS %d %d %d "
ysr@777:                     "PENDING_CARDS %d %d "
ysr@777:                     "CARDS_SCANNED %d %d "
ysr@777:                     "RS_LENGTHS %d %d "
ysr@777:                     "RS_UPDATE %1.6lf %1.6lf RS_SCAN %1.6lf %1.6lf "
ysr@777:                     "SURVIVAL_RATIO %1.6lf %1.6lf "
ysr@777:                     "OBJECT_COPY %1.6lf %1.6lf OTHER_CONSTANT %1.6lf %1.6lf "
ysr@777:                     "OTHER_YOUNG %1.6lf %1.6lf "
ysr@777:                     "OTHER_NON_YOUNG %1.6lf %1.6lf "
ysr@777:                     "VTIME_DIFF %1.6lf TERMINATION %1.6lf "
ysr@777:                     "ELAPSED %1.6lf %1.6lf ",
ysr@777:                     _cur_collection_start_sec,
ysr@777:                     (!_last_young_gc_full) ? 2 :
ysr@777:                     (last_pause_included_initial_mark) ? 1 : 0,
ysr@777:                     _recorded_region_num,
ysr@777:                     _recorded_young_regions,
ysr@777:                     _recorded_non_young_regions,
ysr@777:                     _predicted_pending_cards, _pending_cards,
ysr@777:                     _predicted_cards_scanned, cards_scanned,
ysr@777:                     _predicted_rs_lengths, _max_rs_lengths,
ysr@777:                     _predicted_rs_update_time_ms, update_rs_time,
ysr@777:                     _predicted_rs_scan_time_ms, scan_rs_time,
ysr@777:                     _predicted_survival_ratio, survival_ratio,
ysr@777:                     _predicted_object_copy_time_ms, obj_copy_time,
ysr@777:                     _predicted_constant_other_time_ms, constant_other_time_ms,
ysr@777:                     _predicted_young_other_time_ms, young_other_time_ms,
ysr@777:                     _predicted_non_young_other_time_ms,
ysr@777:                     non_young_other_time_ms,
ysr@777:                     _vtime_diff_ms, termination_time,
ysr@777:                     _predicted_pause_time_ms, elapsed_ms);
ysr@777:     }
ysr@777: 
ysr@777:     if (G1PolicyVerbose > 0) {
ysr@777:       gclog_or_tty->print_cr("Pause Time, predicted: %1.4lfms (predicted %s), actual: %1.4lfms",
ysr@777:                     _predicted_pause_time_ms,
ysr@777:                     (_within_target) ? "within" : "outside",
ysr@777:                     elapsed_ms);
ysr@777:     }
ysr@777: 
ysr@777:   }
ysr@777: 
ysr@777:   _in_marking_window = new_in_marking_window;
ysr@777:   _in_marking_window_im = new_in_marking_window_im;
ysr@777:   _free_regions_at_end_of_collection = _g1->free_regions();
ysr@777:   calculate_young_list_min_length();
johnc@1829:   calculate_young_list_target_length();
ysr@777: 
iveresov@1546:   // Note that _mmu_tracker->max_gc_time() returns the time in seconds.
tonyp@1717:   double update_rs_time_goal_ms = _mmu_tracker->max_gc_time() * MILLIUNITS * G1RSetUpdatingPauseTimePercent / 100.0;
iveresov@1546:   adjust_concurrent_refinement(update_rs_time, update_rs_processed_buffers, update_rs_time_goal_ms);
ysr@777:   // </NEW PREDICTION>
ysr@777: }
ysr@777: 
ysr@777: // <NEW PREDICTION>
ysr@777: 
iveresov@1546: void G1CollectorPolicy::adjust_concurrent_refinement(double update_rs_time,
iveresov@1546:                                                      double update_rs_processed_buffers,
iveresov@1546:                                                      double goal_ms) {
iveresov@1546:   DirtyCardQueueSet& dcqs = JavaThread::dirty_card_queue_set();
iveresov@1546:   ConcurrentG1Refine *cg1r = G1CollectedHeap::heap()->concurrent_g1_refine();
iveresov@1546: 
tonyp@1717:   if (G1UseAdaptiveConcRefinement) {
iveresov@1546:     const int k_gy = 3, k_gr = 6;
iveresov@1546:     const double inc_k = 1.1, dec_k = 0.9;
iveresov@1546: 
iveresov@1546:     int g = cg1r->green_zone();
iveresov@1546:     if (update_rs_time > goal_ms) {
iveresov@1546:       g = (int)(g * dec_k);  // Can become 0, that's OK. That would mean a mutator-only processing.
iveresov@1546:     } else {
iveresov@1546:       if (update_rs_time < goal_ms && update_rs_processed_buffers > g) {
iveresov@1546:         g = (int)MAX2(g * inc_k, g + 1.0);
iveresov@1546:       }
iveresov@1546:     }
iveresov@1546:     // Change the refinement threads params
iveresov@1546:     cg1r->set_green_zone(g);
iveresov@1546:     cg1r->set_yellow_zone(g * k_gy);
iveresov@1546:     cg1r->set_red_zone(g * k_gr);
iveresov@1546:     cg1r->reinitialize_threads();
iveresov@1546: 
iveresov@1546:     int processing_threshold_delta = MAX2((int)(cg1r->green_zone() * sigma()), 1);
iveresov@1546:     int processing_threshold = MIN2(cg1r->green_zone() + processing_threshold_delta,
iveresov@1546:                                     cg1r->yellow_zone());
iveresov@1546:     // Change the barrier params
iveresov@1546:     dcqs.set_process_completed_threshold(processing_threshold);
iveresov@1546:     dcqs.set_max_completed_queue(cg1r->red_zone());
iveresov@1546:   }
iveresov@1546: 
iveresov@1546:   int curr_queue_size = dcqs.completed_buffers_num();
iveresov@1546:   if (curr_queue_size >= cg1r->yellow_zone()) {
iveresov@1546:     dcqs.set_completed_queue_padding(curr_queue_size);
iveresov@1546:   } else {
iveresov@1546:     dcqs.set_completed_queue_padding(0);
iveresov@1546:   }
iveresov@1546:   dcqs.notify_if_necessary();
iveresov@1546: }
iveresov@1546: 
ysr@777: double
ysr@777: G1CollectorPolicy::
ysr@777: predict_young_collection_elapsed_time_ms(size_t adjustment) {
ysr@777:   guarantee( adjustment == 0 || adjustment == 1, "invariant" );
ysr@777: 
ysr@777:   G1CollectedHeap* g1h = G1CollectedHeap::heap();
johnc@1829:   size_t young_num = g1h->young_list()->length();
ysr@777:   if (young_num == 0)
ysr@777:     return 0.0;
ysr@777: 
ysr@777:   young_num += adjustment;
ysr@777:   size_t pending_cards = predict_pending_cards();
johnc@1829:   size_t rs_lengths = g1h->young_list()->sampled_rs_lengths() +
ysr@777:                       predict_rs_length_diff();
ysr@777:   size_t card_num;
ysr@777:   if (full_young_gcs())
ysr@777:     card_num = predict_young_card_num(rs_lengths);
ysr@777:   else
ysr@777:     card_num = predict_non_young_card_num(rs_lengths);
ysr@777:   size_t young_byte_size = young_num * HeapRegion::GrainBytes;
ysr@777:   double accum_yg_surv_rate =
ysr@777:     _short_lived_surv_rate_group->accum_surv_rate(adjustment);
ysr@777: 
ysr@777:   size_t bytes_to_copy =
ysr@777:     (size_t) (accum_yg_surv_rate * (double) HeapRegion::GrainBytes);
ysr@777: 
ysr@777:   return
ysr@777:     predict_rs_update_time_ms(pending_cards) +
ysr@777:     predict_rs_scan_time_ms(card_num) +
ysr@777:     predict_object_copy_time_ms(bytes_to_copy) +
ysr@777:     predict_young_other_time_ms(young_num) +
ysr@777:     predict_constant_other_time_ms();
ysr@777: }
ysr@777: 
ysr@777: double
ysr@777: G1CollectorPolicy::predict_base_elapsed_time_ms(size_t pending_cards) {
ysr@777:   size_t rs_length = predict_rs_length_diff();
ysr@777:   size_t card_num;
ysr@777:   if (full_young_gcs())
ysr@777:     card_num = predict_young_card_num(rs_length);
ysr@777:   else
ysr@777:     card_num = predict_non_young_card_num(rs_length);
ysr@777:   return predict_base_elapsed_time_ms(pending_cards, card_num);
ysr@777: }
ysr@777: 
ysr@777: double
ysr@777: G1CollectorPolicy::predict_base_elapsed_time_ms(size_t pending_cards,
ysr@777:                                                 size_t scanned_cards) {
ysr@777:   return
ysr@777:     predict_rs_update_time_ms(pending_cards) +
ysr@777:     predict_rs_scan_time_ms(scanned_cards) +
ysr@777:     predict_constant_other_time_ms();
ysr@777: }
ysr@777: 
ysr@777: double
ysr@777: G1CollectorPolicy::predict_region_elapsed_time_ms(HeapRegion* hr,
ysr@777:                                                   bool young) {
ysr@777:   size_t rs_length = hr->rem_set()->occupied();
ysr@777:   size_t card_num;
ysr@777:   if (full_young_gcs())
ysr@777:     card_num = predict_young_card_num(rs_length);
ysr@777:   else
ysr@777:     card_num = predict_non_young_card_num(rs_length);
ysr@777:   size_t bytes_to_copy = predict_bytes_to_copy(hr);
ysr@777: 
ysr@777:   double region_elapsed_time_ms =
ysr@777:     predict_rs_scan_time_ms(card_num) +
ysr@777:     predict_object_copy_time_ms(bytes_to_copy);
ysr@777: 
ysr@777:   if (young)
ysr@777:     region_elapsed_time_ms += predict_young_other_time_ms(1);
ysr@777:   else
ysr@777:     region_elapsed_time_ms += predict_non_young_other_time_ms(1);
ysr@777: 
ysr@777:   return region_elapsed_time_ms;
ysr@777: }
ysr@777: 
ysr@777: size_t
ysr@777: G1CollectorPolicy::predict_bytes_to_copy(HeapRegion* hr) {
ysr@777:   size_t bytes_to_copy;
ysr@777:   if (hr->is_marked())
ysr@777:     bytes_to_copy = hr->max_live_bytes();
ysr@777:   else {
ysr@777:     guarantee( hr->is_young() && hr->age_in_surv_rate_group() != -1,
ysr@777:                "invariant" );
ysr@777:     int age = hr->age_in_surv_rate_group();
apetrusenko@980:     double yg_surv_rate = predict_yg_surv_rate(age, hr->surv_rate_group());
ysr@777:     bytes_to_copy = (size_t) ((double) hr->used() * yg_surv_rate);
ysr@777:   }
ysr@777: 
ysr@777:   return bytes_to_copy;
ysr@777: }
ysr@777: 
ysr@777: void
ysr@777: G1CollectorPolicy::start_recording_regions() {
ysr@777:   _recorded_rs_lengths            = 0;
ysr@777:   _recorded_young_regions         = 0;
ysr@777:   _recorded_non_young_regions     = 0;
ysr@777: 
ysr@777: #if PREDICTIONS_VERBOSE
ysr@777:   _recorded_marked_bytes          = 0;
ysr@777:   _recorded_young_bytes           = 0;
ysr@777:   _predicted_bytes_to_copy        = 0;
johnc@1829:   _predicted_rs_lengths           = 0;
johnc@1829:   _predicted_cards_scanned        = 0;
ysr@777: #endif // PREDICTIONS_VERBOSE
ysr@777: }
ysr@777: 
ysr@777: void
johnc@1829: G1CollectorPolicy::record_cset_region_info(HeapRegion* hr, bool young) {
ysr@777: #if PREDICTIONS_VERBOSE
johnc@1829:   if (!young) {
ysr@777:     _recorded_marked_bytes += hr->max_live_bytes();
ysr@777:   }
ysr@777:   _predicted_bytes_to_copy += predict_bytes_to_copy(hr);
ysr@777: #endif // PREDICTIONS_VERBOSE
ysr@777: 
ysr@777:   size_t rs_length = hr->rem_set()->occupied();
ysr@777:   _recorded_rs_lengths += rs_length;
ysr@777: }
ysr@777: 
ysr@777: void
johnc@1829: G1CollectorPolicy::record_non_young_cset_region(HeapRegion* hr) {
johnc@1829:   assert(!hr->is_young(), "should not call this");
johnc@1829:   ++_recorded_non_young_regions;
johnc@1829:   record_cset_region_info(hr, false);
johnc@1829: }
johnc@1829: 
johnc@1829: void
johnc@1829: G1CollectorPolicy::set_recorded_young_regions(size_t n_regions) {
johnc@1829:   _recorded_young_regions = n_regions;
johnc@1829: }
johnc@1829: 
johnc@1829: void G1CollectorPolicy::set_recorded_young_bytes(size_t bytes) {
johnc@1829: #if PREDICTIONS_VERBOSE
johnc@1829:   _recorded_young_bytes = bytes;
johnc@1829: #endif // PREDICTIONS_VERBOSE
johnc@1829: }
johnc@1829: 
johnc@1829: void G1CollectorPolicy::set_recorded_rs_lengths(size_t rs_lengths) {
johnc@1829:   _recorded_rs_lengths = rs_lengths;
johnc@1829: }
johnc@1829: 
johnc@1829: void G1CollectorPolicy::set_predicted_bytes_to_copy(size_t bytes) {
johnc@1829:   _predicted_bytes_to_copy = bytes;
ysr@777: }
ysr@777: 
ysr@777: void
ysr@777: G1CollectorPolicy::end_recording_regions() {
johnc@1829:   // The _predicted_pause_time_ms field is referenced in code
johnc@1829:   // not under PREDICTIONS_VERBOSE. Let's initialize it.
johnc@1829:   _predicted_pause_time_ms = -1.0;
johnc@1829: 
ysr@777: #if PREDICTIONS_VERBOSE
ysr@777:   _predicted_pending_cards = predict_pending_cards();
ysr@777:   _predicted_rs_lengths = _recorded_rs_lengths + predict_rs_length_diff();
ysr@777:   if (full_young_gcs())
ysr@777:     _predicted_cards_scanned += predict_young_card_num(_predicted_rs_lengths);
ysr@777:   else
ysr@777:     _predicted_cards_scanned +=
ysr@777:       predict_non_young_card_num(_predicted_rs_lengths);
ysr@777:   _recorded_region_num = _recorded_young_regions + _recorded_non_young_regions;
ysr@777: 
ysr@777:   _predicted_rs_update_time_ms =
ysr@777:     predict_rs_update_time_ms(_g1->pending_card_num());
ysr@777:   _predicted_rs_scan_time_ms =
ysr@777:     predict_rs_scan_time_ms(_predicted_cards_scanned);
ysr@777:   _predicted_object_copy_time_ms =
ysr@777:     predict_object_copy_time_ms(_predicted_bytes_to_copy);
ysr@777:   _predicted_constant_other_time_ms =
ysr@777:     predict_constant_other_time_ms();
ysr@777:   _predicted_young_other_time_ms =
ysr@777:     predict_young_other_time_ms(_recorded_young_regions);
ysr@777:   _predicted_non_young_other_time_ms =
ysr@777:     predict_non_young_other_time_ms(_recorded_non_young_regions);
ysr@777: 
ysr@777:   _predicted_pause_time_ms =
ysr@777:     _predicted_rs_update_time_ms +
ysr@777:     _predicted_rs_scan_time_ms +
ysr@777:     _predicted_object_copy_time_ms +
ysr@777:     _predicted_constant_other_time_ms +
ysr@777:     _predicted_young_other_time_ms +
ysr@777:     _predicted_non_young_other_time_ms;
ysr@777: #endif // PREDICTIONS_VERBOSE
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::check_if_region_is_too_expensive(double
ysr@777:                                                            predicted_time_ms) {
ysr@777:   // I don't think we need to do this when in young GC mode since
ysr@777:   // marking will be initiated next time we hit the soft limit anyway...
ysr@777:   if (predicted_time_ms > _expensive_region_limit_ms) {
ysr@777:     if (!in_young_gc_mode()) {
ysr@777:         set_full_young_gcs(true);
tonyp@1794:         // We might want to do something different here. However,
tonyp@1794:         // right now we don't support the non-generational G1 mode
tonyp@1794:         // (and in fact we are planning to remove the associated code,
tonyp@1794:         // see CR 6814390). So, let's leave it as is and this will be
tonyp@1794:         // removed some time in the future
tonyp@1794:         ShouldNotReachHere();
tonyp@1794:         set_during_initial_mark_pause();
ysr@777:     } else
ysr@777:       // no point in doing another partial one
ysr@777:       _should_revert_to_full_young_gcs = true;
ysr@777:   }
ysr@777: }
ysr@777: 
ysr@777: // </NEW PREDICTION>
ysr@777: 
ysr@777: 
ysr@777: void G1CollectorPolicy::update_recent_gc_times(double end_time_sec,
ysr@777:                                                double elapsed_ms) {
ysr@777:   _recent_gc_times_ms->add(elapsed_ms);
ysr@777:   _recent_prev_end_times_for_all_gcs_sec->add(end_time_sec);
ysr@777:   _prev_collection_pause_end_ms = end_time_sec * 1000.0;
ysr@777: }
ysr@777: 
ysr@777: double G1CollectorPolicy::recent_avg_time_for_pauses_ms() {
johnc@1186:   if (_recent_pause_times_ms->num() == 0) return (double) MaxGCPauseMillis;
ysr@777:   else return _recent_pause_times_ms->avg();
ysr@777: }
ysr@777: 
ysr@777: double G1CollectorPolicy::recent_avg_time_for_CH_strong_ms() {
ysr@777:   if (_recent_CH_strong_roots_times_ms->num() == 0)
johnc@1186:     return (double)MaxGCPauseMillis/3.0;
ysr@777:   else return _recent_CH_strong_roots_times_ms->avg();
ysr@777: }
ysr@777: 
ysr@777: double G1CollectorPolicy::recent_avg_time_for_G1_strong_ms() {
ysr@777:   if (_recent_G1_strong_roots_times_ms->num() == 0)
johnc@1186:     return (double)MaxGCPauseMillis/3.0;
ysr@777:   else return _recent_G1_strong_roots_times_ms->avg();
ysr@777: }
ysr@777: 
ysr@777: double G1CollectorPolicy::recent_avg_time_for_evac_ms() {
johnc@1186:   if (_recent_evac_times_ms->num() == 0) return (double)MaxGCPauseMillis/3.0;
ysr@777:   else return _recent_evac_times_ms->avg();
ysr@777: }
ysr@777: 
ysr@777: int G1CollectorPolicy::number_of_recent_gcs() {
ysr@777:   assert(_recent_CH_strong_roots_times_ms->num() ==
ysr@777:          _recent_G1_strong_roots_times_ms->num(), "Sequence out of sync");
ysr@777:   assert(_recent_G1_strong_roots_times_ms->num() ==
ysr@777:          _recent_evac_times_ms->num(), "Sequence out of sync");
ysr@777:   assert(_recent_evac_times_ms->num() ==
ysr@777:          _recent_pause_times_ms->num(), "Sequence out of sync");
ysr@777:   assert(_recent_pause_times_ms->num() ==
ysr@777:          _recent_CS_bytes_used_before->num(), "Sequence out of sync");
ysr@777:   assert(_recent_CS_bytes_used_before->num() ==
ysr@777:          _recent_CS_bytes_surviving->num(), "Sequence out of sync");
ysr@777:   return _recent_pause_times_ms->num();
ysr@777: }
ysr@777: 
ysr@777: double G1CollectorPolicy::recent_avg_survival_fraction() {
ysr@777:   return recent_avg_survival_fraction_work(_recent_CS_bytes_surviving,
ysr@777:                                            _recent_CS_bytes_used_before);
ysr@777: }
ysr@777: 
ysr@777: double G1CollectorPolicy::last_survival_fraction() {
ysr@777:   return last_survival_fraction_work(_recent_CS_bytes_surviving,
ysr@777:                                      _recent_CS_bytes_used_before);
ysr@777: }
ysr@777: 
ysr@777: double
ysr@777: G1CollectorPolicy::recent_avg_survival_fraction_work(TruncatedSeq* surviving,
ysr@777:                                                      TruncatedSeq* before) {
ysr@777:   assert(surviving->num() == before->num(), "Sequence out of sync");
ysr@777:   if (before->sum() > 0.0) {
ysr@777:       double recent_survival_rate = surviving->sum() / before->sum();
ysr@777:       // We exempt parallel collection from this check because Alloc Buffer
ysr@777:       // fragmentation can produce negative collections.
ysr@777:       // Further, we're now always doing parallel collection.  But I'm still
ysr@777:       // leaving this here as a placeholder for a more precise assertion later.
ysr@777:       // (DLD, 10/05.)
ysr@777:       assert((true || ParallelGCThreads > 0) ||
ysr@777:              _g1->evacuation_failed() ||
ysr@777:              recent_survival_rate <= 1.0, "Or bad frac");
ysr@777:       return recent_survival_rate;
ysr@777:   } else {
ysr@777:     return 1.0; // Be conservative.
ysr@777:   }
ysr@777: }
ysr@777: 
ysr@777: double
ysr@777: G1CollectorPolicy::last_survival_fraction_work(TruncatedSeq* surviving,
ysr@777:                                                TruncatedSeq* before) {
ysr@777:   assert(surviving->num() == before->num(), "Sequence out of sync");
ysr@777:   if (surviving->num() > 0 && before->last() > 0.0) {
ysr@777:     double last_survival_rate = surviving->last() / before->last();
ysr@777:     // We exempt parallel collection from this check because Alloc Buffer
ysr@777:     // fragmentation can produce negative collections.
ysr@777:     // Further, we're now always doing parallel collection.  But I'm still
ysr@777:     // leaving this here as a placeholder for a more precise assertion later.
ysr@777:     // (DLD, 10/05.)
ysr@777:     assert((true || ParallelGCThreads > 0) ||
ysr@777:            last_survival_rate <= 1.0, "Or bad frac");
ysr@777:     return last_survival_rate;
ysr@777:   } else {
ysr@777:     return 1.0;
ysr@777:   }
ysr@777: }
ysr@777: 
ysr@777: static const int survival_min_obs = 5;
ysr@777: static double survival_min_obs_limits[] = { 0.9, 0.7, 0.5, 0.3, 0.1 };
ysr@777: static const double min_survival_rate = 0.1;
ysr@777: 
ysr@777: double
ysr@777: G1CollectorPolicy::conservative_avg_survival_fraction_work(double avg,
ysr@777:                                                            double latest) {
ysr@777:   double res = avg;
ysr@777:   if (number_of_recent_gcs() < survival_min_obs) {
ysr@777:     res = MAX2(res, survival_min_obs_limits[number_of_recent_gcs()]);
ysr@777:   }
ysr@777:   res = MAX2(res, latest);
ysr@777:   res = MAX2(res, min_survival_rate);
ysr@777:   // In the parallel case, LAB fragmentation can produce "negative
ysr@777:   // collections"; so can evac failure.  Cap at 1.0
ysr@777:   res = MIN2(res, 1.0);
ysr@777:   return res;
ysr@777: }
ysr@777: 
ysr@777: size_t G1CollectorPolicy::expansion_amount() {
tonyp@1791:   if ((recent_avg_pause_time_ratio() * 100.0) > _gc_overhead_perc) {
johnc@1186:     // We will double the existing space, or take
johnc@1186:     // G1ExpandByPercentOfAvailable % of the available expansion
johnc@1186:     // space, whichever is smaller, bounded below by a minimum
johnc@1186:     // expansion (unless that's all that's left.)
ysr@777:     const size_t min_expand_bytes = 1*M;
ysr@777:     size_t reserved_bytes = _g1->g1_reserved_obj_bytes();
ysr@777:     size_t committed_bytes = _g1->capacity();
ysr@777:     size_t uncommitted_bytes = reserved_bytes - committed_bytes;
ysr@777:     size_t expand_bytes;
ysr@777:     size_t expand_bytes_via_pct =
johnc@1186:       uncommitted_bytes * G1ExpandByPercentOfAvailable / 100;
ysr@777:     expand_bytes = MIN2(expand_bytes_via_pct, committed_bytes);
ysr@777:     expand_bytes = MAX2(expand_bytes, min_expand_bytes);
ysr@777:     expand_bytes = MIN2(expand_bytes, uncommitted_bytes);
ysr@777:     if (G1PolicyVerbose > 1) {
ysr@777:       gclog_or_tty->print("Decided to expand: ratio = %5.2f, "
ysr@777:                  "committed = %d%s, uncommited = %d%s, via pct = %d%s.\n"
ysr@777:                  "                   Answer = %d.\n",
ysr@777:                  recent_avg_pause_time_ratio(),
ysr@777:                  byte_size_in_proper_unit(committed_bytes),
ysr@777:                  proper_unit_for_byte_size(committed_bytes),
ysr@777:                  byte_size_in_proper_unit(uncommitted_bytes),
ysr@777:                  proper_unit_for_byte_size(uncommitted_bytes),
ysr@777:                  byte_size_in_proper_unit(expand_bytes_via_pct),
ysr@777:                  proper_unit_for_byte_size(expand_bytes_via_pct),
ysr@777:                  byte_size_in_proper_unit(expand_bytes),
ysr@777:                  proper_unit_for_byte_size(expand_bytes));
ysr@777:     }
ysr@777:     return expand_bytes;
ysr@777:   } else {
ysr@777:     return 0;
ysr@777:   }
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::note_start_of_mark_thread() {
ysr@777:   _mark_thread_startup_sec = os::elapsedTime();
ysr@777: }
ysr@777: 
ysr@777: class CountCSClosure: public HeapRegionClosure {
ysr@777:   G1CollectorPolicy* _g1_policy;
ysr@777: public:
ysr@777:   CountCSClosure(G1CollectorPolicy* g1_policy) :
ysr@777:     _g1_policy(g1_policy) {}
ysr@777:   bool doHeapRegion(HeapRegion* r) {
ysr@777:     _g1_policy->_bytes_in_collection_set_before_gc += r->used();
ysr@777:     return false;
ysr@777:   }
ysr@777: };
ysr@777: 
ysr@777: void G1CollectorPolicy::count_CS_bytes_used() {
ysr@777:   CountCSClosure cs_closure(this);
ysr@777:   _g1->collection_set_iterate(&cs_closure);
ysr@777: }
ysr@777: 
ysr@777: static void print_indent(int level) {
ysr@777:   for (int j = 0; j < level+1; ++j)
ysr@777:     gclog_or_tty->print("   ");
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::print_summary (int level,
ysr@777:                                        const char* str,
ysr@777:                                        NumberSeq* seq) const {
ysr@777:   double sum = seq->sum();
ysr@777:   print_indent(level);
ysr@777:   gclog_or_tty->print_cr("%-24s = %8.2lf s (avg = %8.2lf ms)",
ysr@777:                 str, sum / 1000.0, seq->avg());
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::print_summary_sd (int level,
ysr@777:                                           const char* str,
ysr@777:                                           NumberSeq* seq) const {
ysr@777:   print_summary(level, str, seq);
ysr@777:   print_indent(level + 5);
ysr@777:   gclog_or_tty->print_cr("(num = %5d, std dev = %8.2lf ms, max = %8.2lf ms)",
ysr@777:                 seq->num(), seq->sd(), seq->maximum());
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::check_other_times(int level,
ysr@777:                                         NumberSeq* other_times_ms,
ysr@777:                                         NumberSeq* calc_other_times_ms) const {
ysr@777:   bool should_print = false;
ysr@777: 
ysr@777:   double max_sum = MAX2(fabs(other_times_ms->sum()),
ysr@777:                         fabs(calc_other_times_ms->sum()));
ysr@777:   double min_sum = MIN2(fabs(other_times_ms->sum()),
ysr@777:                         fabs(calc_other_times_ms->sum()));
ysr@777:   double sum_ratio = max_sum / min_sum;
ysr@777:   if (sum_ratio > 1.1) {
ysr@777:     should_print = true;
ysr@777:     print_indent(level + 1);
ysr@777:     gclog_or_tty->print_cr("## CALCULATED OTHER SUM DOESN'T MATCH RECORDED ###");
ysr@777:   }
ysr@777: 
ysr@777:   double max_avg = MAX2(fabs(other_times_ms->avg()),
ysr@777:                         fabs(calc_other_times_ms->avg()));
ysr@777:   double min_avg = MIN2(fabs(other_times_ms->avg()),
ysr@777:                         fabs(calc_other_times_ms->avg()));
ysr@777:   double avg_ratio = max_avg / min_avg;
ysr@777:   if (avg_ratio > 1.1) {
ysr@777:     should_print = true;
ysr@777:     print_indent(level + 1);
ysr@777:     gclog_or_tty->print_cr("## CALCULATED OTHER AVG DOESN'T MATCH RECORDED ###");
ysr@777:   }
ysr@777: 
ysr@777:   if (other_times_ms->sum() < -0.01) {
ysr@777:     print_indent(level + 1);
ysr@777:     gclog_or_tty->print_cr("## RECORDED OTHER SUM IS NEGATIVE ###");
ysr@777:   }
ysr@777: 
ysr@777:   if (other_times_ms->avg() < -0.01) {
ysr@777:     print_indent(level + 1);
ysr@777:     gclog_or_tty->print_cr("## RECORDED OTHER AVG IS NEGATIVE ###");
ysr@777:   }
ysr@777: 
ysr@777:   if (calc_other_times_ms->sum() < -0.01) {
ysr@777:     should_print = true;
ysr@777:     print_indent(level + 1);
ysr@777:     gclog_or_tty->print_cr("## CALCULATED OTHER SUM IS NEGATIVE ###");
ysr@777:   }
ysr@777: 
ysr@777:   if (calc_other_times_ms->avg() < -0.01) {
ysr@777:     should_print = true;
ysr@777:     print_indent(level + 1);
ysr@777:     gclog_or_tty->print_cr("## CALCULATED OTHER AVG IS NEGATIVE ###");
ysr@777:   }
ysr@777: 
ysr@777:   if (should_print)
ysr@777:     print_summary(level, "Other(Calc)", calc_other_times_ms);
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::print_summary(PauseSummary* summary) const {
ysr@777:   bool parallel = ParallelGCThreads > 0;
ysr@777:   MainBodySummary*    body_summary = summary->main_body_summary();
ysr@777:   if (summary->get_total_seq()->num() > 0) {
apetrusenko@1112:     print_summary_sd(0, "Evacuation Pauses", summary->get_total_seq());
ysr@777:     if (body_summary != NULL) {
ysr@777:       print_summary(1, "SATB Drain", body_summary->get_satb_drain_seq());
ysr@777:       if (parallel) {
ysr@777:         print_summary(1, "Parallel Time", body_summary->get_parallel_seq());
ysr@777:         print_summary(2, "Update RS", body_summary->get_update_rs_seq());
ysr@777:         print_summary(2, "Ext Root Scanning",
ysr@777:                       body_summary->get_ext_root_scan_seq());
ysr@777:         print_summary(2, "Mark Stack Scanning",
ysr@777:                       body_summary->get_mark_stack_scan_seq());
ysr@777:         print_summary(2, "Scan RS", body_summary->get_scan_rs_seq());
ysr@777:         print_summary(2, "Object Copy", body_summary->get_obj_copy_seq());
ysr@777:         print_summary(2, "Termination", body_summary->get_termination_seq());
ysr@777:         print_summary(2, "Other", body_summary->get_parallel_other_seq());
ysr@777:         {
ysr@777:           NumberSeq* other_parts[] = {
ysr@777:             body_summary->get_update_rs_seq(),
ysr@777:             body_summary->get_ext_root_scan_seq(),
ysr@777:             body_summary->get_mark_stack_scan_seq(),
ysr@777:             body_summary->get_scan_rs_seq(),
ysr@777:             body_summary->get_obj_copy_seq(),
ysr@777:             body_summary->get_termination_seq()
ysr@777:           };
ysr@777:           NumberSeq calc_other_times_ms(body_summary->get_parallel_seq(),
ysr@777:                                         7, other_parts);
ysr@777:           check_other_times(2, body_summary->get_parallel_other_seq(),
ysr@777:                             &calc_other_times_ms);
ysr@777:         }
ysr@777:         print_summary(1, "Mark Closure", body_summary->get_mark_closure_seq());
ysr@777:         print_summary(1, "Clear CT", body_summary->get_clear_ct_seq());
ysr@777:       } else {
ysr@777:         print_summary(1, "Update RS", body_summary->get_update_rs_seq());
ysr@777:         print_summary(1, "Ext Root Scanning",
ysr@777:                       body_summary->get_ext_root_scan_seq());
ysr@777:         print_summary(1, "Mark Stack Scanning",
ysr@777:                       body_summary->get_mark_stack_scan_seq());
ysr@777:         print_summary(1, "Scan RS", body_summary->get_scan_rs_seq());
ysr@777:         print_summary(1, "Object Copy", body_summary->get_obj_copy_seq());
ysr@777:       }
ysr@777:     }
ysr@777:     print_summary(1, "Other", summary->get_other_seq());
ysr@777:     {
ysr@777:       NumberSeq calc_other_times_ms;
ysr@777:       if (body_summary != NULL) {
ysr@777:         // not abandoned
ysr@777:         if (parallel) {
ysr@777:           // parallel
ysr@777:           NumberSeq* other_parts[] = {
ysr@777:             body_summary->get_satb_drain_seq(),
ysr@777:             body_summary->get_parallel_seq(),
ysr@777:             body_summary->get_clear_ct_seq()
ysr@777:           };
apetrusenko@1112:           calc_other_times_ms = NumberSeq(summary->get_total_seq(),
apetrusenko@1112:                                           3, other_parts);
ysr@777:         } else {
ysr@777:           // serial
ysr@777:           NumberSeq* other_parts[] = {
ysr@777:             body_summary->get_satb_drain_seq(),
ysr@777:             body_summary->get_update_rs_seq(),
ysr@777:             body_summary->get_ext_root_scan_seq(),
ysr@777:             body_summary->get_mark_stack_scan_seq(),
ysr@777:             body_summary->get_scan_rs_seq(),
ysr@777:             body_summary->get_obj_copy_seq()
ysr@777:           };
ysr@777:           calc_other_times_ms = NumberSeq(summary->get_total_seq(),
apetrusenko@1112:                                           7, other_parts);
ysr@777:         }
ysr@777:       } else {
ysr@777:         // abandoned
apetrusenko@1112:         calc_other_times_ms = NumberSeq();
ysr@777:       }
ysr@777:       check_other_times(1,  summary->get_other_seq(), &calc_other_times_ms);
ysr@777:     }
ysr@777:   } else {
ysr@777:     print_indent(0);
ysr@777:     gclog_or_tty->print_cr("none");
ysr@777:   }
ysr@777:   gclog_or_tty->print_cr("");
ysr@777: }
ysr@777: 
ysr@777: void
apetrusenko@1112: G1CollectorPolicy::print_abandoned_summary(PauseSummary* summary) const {
ysr@777:   bool printed = false;
apetrusenko@1112:   if (summary->get_total_seq()->num() > 0) {
ysr@777:     printed = true;
apetrusenko@1112:     print_summary(summary);
ysr@777:   }
ysr@777:   if (!printed) {
ysr@777:     print_indent(0);
ysr@777:     gclog_or_tty->print_cr("none");
ysr@777:     gclog_or_tty->print_cr("");
ysr@777:   }
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::print_tracing_info() const {
ysr@777:   if (TraceGen0Time) {
ysr@777:     gclog_or_tty->print_cr("ALL PAUSES");
ysr@777:     print_summary_sd(0, "Total", _all_pause_times_ms);
ysr@777:     gclog_or_tty->print_cr("");
ysr@777:     gclog_or_tty->print_cr("");
ysr@777:     gclog_or_tty->print_cr("   Full Young GC Pauses:    %8d", _full_young_pause_num);
ysr@777:     gclog_or_tty->print_cr("   Partial Young GC Pauses: %8d", _partial_young_pause_num);
ysr@777:     gclog_or_tty->print_cr("");
ysr@777: 
apetrusenko@1112:     gclog_or_tty->print_cr("EVACUATION PAUSES");
apetrusenko@1112:     print_summary(_summary);
ysr@777: 
ysr@777:     gclog_or_tty->print_cr("ABANDONED PAUSES");
apetrusenko@1112:     print_abandoned_summary(_abandoned_summary);
ysr@777: 
ysr@777:     gclog_or_tty->print_cr("MISC");
ysr@777:     print_summary_sd(0, "Stop World", _all_stop_world_times_ms);
ysr@777:     print_summary_sd(0, "Yields", _all_yield_times_ms);
ysr@777:     for (int i = 0; i < _aux_num; ++i) {
ysr@777:       if (_all_aux_times_ms[i].num() > 0) {
ysr@777:         char buffer[96];
ysr@777:         sprintf(buffer, "Aux%d", i);
ysr@777:         print_summary_sd(0, buffer, &_all_aux_times_ms[i]);
ysr@777:       }
ysr@777:     }
ysr@777: 
ysr@777:     size_t all_region_num = _region_num_young + _region_num_tenured;
ysr@777:     gclog_or_tty->print_cr("   New Regions %8d, Young %8d (%6.2lf%%), "
ysr@777:                "Tenured %8d (%6.2lf%%)",
ysr@777:                all_region_num,
ysr@777:                _region_num_young,
ysr@777:                (double) _region_num_young / (double) all_region_num * 100.0,
ysr@777:                _region_num_tenured,
ysr@777:                (double) _region_num_tenured / (double) all_region_num * 100.0);
ysr@777:   }
ysr@777:   if (TraceGen1Time) {
ysr@777:     if (_all_full_gc_times_ms->num() > 0) {
ysr@777:       gclog_or_tty->print("\n%4d full_gcs: total time = %8.2f s",
ysr@777:                  _all_full_gc_times_ms->num(),
ysr@777:                  _all_full_gc_times_ms->sum() / 1000.0);
ysr@777:       gclog_or_tty->print_cr(" (avg = %8.2fms).", _all_full_gc_times_ms->avg());
ysr@777:       gclog_or_tty->print_cr("                     [std. dev = %8.2f ms, max = %8.2f ms]",
ysr@777:                     _all_full_gc_times_ms->sd(),
ysr@777:                     _all_full_gc_times_ms->maximum());
ysr@777:     }
ysr@777:   }
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy::print_yg_surv_rate_info() const {
ysr@777: #ifndef PRODUCT
ysr@777:   _short_lived_surv_rate_group->print_surv_rate_summary();
ysr@777:   // add this call for any other surv rate groups
ysr@777: #endif // PRODUCT
ysr@777: }
ysr@777: 
ysr@777: bool
ysr@777: G1CollectorPolicy::should_add_next_region_to_young_list() {
ysr@777:   assert(in_young_gc_mode(), "should be in young GC mode");
ysr@777:   bool ret;
johnc@1829:   size_t young_list_length = _g1->young_list()->length();
apetrusenko@980:   size_t young_list_max_length = _young_list_target_length;
apetrusenko@980:   if (G1FixedEdenSize) {
apetrusenko@980:     young_list_max_length -= _max_survivor_regions;
apetrusenko@980:   }
apetrusenko@980:   if (young_list_length < young_list_max_length) {
ysr@777:     ret = true;
ysr@777:     ++_region_num_young;
ysr@777:   } else {
ysr@777:     ret = false;
ysr@777:     ++_region_num_tenured;
ysr@777:   }
ysr@777: 
ysr@777:   return ret;
ysr@777: }
ysr@777: 
ysr@777: #ifndef PRODUCT
ysr@777: // for debugging, bit of a hack...
ysr@777: static char*
ysr@777: region_num_to_mbs(int length) {
ysr@777:   static char buffer[64];
ysr@777:   double bytes = (double) (length * HeapRegion::GrainBytes);
ysr@777:   double mbs = bytes / (double) (1024 * 1024);
ysr@777:   sprintf(buffer, "%7.2lfMB", mbs);
ysr@777:   return buffer;
ysr@777: }
ysr@777: #endif // PRODUCT
ysr@777: 
apetrusenko@980: size_t G1CollectorPolicy::max_regions(int purpose) {
ysr@777:   switch (purpose) {
ysr@777:     case GCAllocForSurvived:
apetrusenko@980:       return _max_survivor_regions;
ysr@777:     case GCAllocForTenured:
apetrusenko@980:       return REGIONS_UNLIMITED;
ysr@777:     default:
apetrusenko@980:       ShouldNotReachHere();
apetrusenko@980:       return REGIONS_UNLIMITED;
ysr@777:   };
ysr@777: }
ysr@777: 
apetrusenko@980: // Calculates survivor space parameters.
apetrusenko@980: void G1CollectorPolicy::calculate_survivors_policy()
apetrusenko@980: {
apetrusenko@980:   if (G1FixedSurvivorSpaceSize == 0) {
apetrusenko@980:     _max_survivor_regions = _young_list_target_length / SurvivorRatio;
apetrusenko@980:   } else {
apetrusenko@982:     _max_survivor_regions = G1FixedSurvivorSpaceSize / HeapRegion::GrainBytes;
apetrusenko@980:   }
apetrusenko@980: 
apetrusenko@980:   if (G1FixedTenuringThreshold) {
apetrusenko@980:     _tenuring_threshold = MaxTenuringThreshold;
apetrusenko@980:   } else {
apetrusenko@980:     _tenuring_threshold = _survivors_age_table.compute_tenuring_threshold(
apetrusenko@980:         HeapRegion::GrainWords * _max_survivor_regions);
apetrusenko@980:   }
apetrusenko@980: }
apetrusenko@980: 
ysr@777: bool
ysr@777: G1CollectorPolicy_BestRegionsFirst::should_do_collection_pause(size_t
ysr@777:                                                                word_size) {
ysr@777:   assert(_g1->regions_accounted_for(), "Region leakage!");
ysr@777:   double max_pause_time_ms = _mmu_tracker->max_gc_time() * 1000.0;
ysr@777: 
johnc@1829:   size_t young_list_length = _g1->young_list()->length();
apetrusenko@980:   size_t young_list_max_length = _young_list_target_length;
apetrusenko@980:   if (G1FixedEdenSize) {
apetrusenko@980:     young_list_max_length -= _max_survivor_regions;
apetrusenko@980:   }
apetrusenko@980:   bool reached_target_length = young_list_length >= young_list_max_length;
ysr@777: 
ysr@777:   if (in_young_gc_mode()) {
ysr@777:     if (reached_target_length) {
johnc@1829:       assert( young_list_length > 0 && _g1->young_list()->length() > 0,
ysr@777:               "invariant" );
ysr@777:       return true;
ysr@777:     }
ysr@777:   } else {
ysr@777:     guarantee( false, "should not reach here" );
ysr@777:   }
ysr@777: 
ysr@777:   return false;
ysr@777: }
ysr@777: 
ysr@777: #ifndef PRODUCT
ysr@777: class HRSortIndexIsOKClosure: public HeapRegionClosure {
ysr@777:   CollectionSetChooser* _chooser;
ysr@777: public:
ysr@777:   HRSortIndexIsOKClosure(CollectionSetChooser* chooser) :
ysr@777:     _chooser(chooser) {}
ysr@777: 
ysr@777:   bool doHeapRegion(HeapRegion* r) {
ysr@777:     if (!r->continuesHumongous()) {
ysr@777:       assert(_chooser->regionProperlyOrdered(r), "Ought to be.");
ysr@777:     }
ysr@777:     return false;
ysr@777:   }
ysr@777: };
ysr@777: 
ysr@777: bool G1CollectorPolicy_BestRegionsFirst::assertMarkedBytesDataOK() {
ysr@777:   HRSortIndexIsOKClosure cl(_collectionSetChooser);
ysr@777:   _g1->heap_region_iterate(&cl);
ysr@777:   return true;
ysr@777: }
ysr@777: #endif
ysr@777: 
tonyp@2011: bool
tonyp@2011: G1CollectorPolicy::force_initial_mark_if_outside_cycle() {
tonyp@2011:   bool during_cycle = _g1->concurrent_mark()->cmThread()->during_cycle();
tonyp@2011:   if (!during_cycle) {
tonyp@2011:     set_initiate_conc_mark_if_possible();
tonyp@2011:     return true;
tonyp@2011:   } else {
tonyp@2011:     return false;
tonyp@2011:   }
tonyp@2011: }
tonyp@2011: 
ysr@777: void
tonyp@1794: G1CollectorPolicy::decide_on_conc_mark_initiation() {
tonyp@1794:   // We are about to decide on whether this pause will be an
tonyp@1794:   // initial-mark pause.
tonyp@1794: 
tonyp@1794:   // First, during_initial_mark_pause() should not be already set. We
tonyp@1794:   // will set it here if we have to. However, it should be cleared by
tonyp@1794:   // the end of the pause (it's only set for the duration of an
tonyp@1794:   // initial-mark pause).
tonyp@1794:   assert(!during_initial_mark_pause(), "pre-condition");
tonyp@1794: 
tonyp@1794:   if (initiate_conc_mark_if_possible()) {
tonyp@1794:     // We had noticed on a previous pause that the heap occupancy has
tonyp@1794:     // gone over the initiating threshold and we should start a
tonyp@1794:     // concurrent marking cycle. So we might initiate one.
tonyp@1794: 
tonyp@1794:     bool during_cycle = _g1->concurrent_mark()->cmThread()->during_cycle();
tonyp@1794:     if (!during_cycle) {
tonyp@1794:       // The concurrent marking thread is not "during a cycle", i.e.,
tonyp@1794:       // it has completed the last one. So we can go ahead and
tonyp@1794:       // initiate a new cycle.
tonyp@1794: 
tonyp@1794:       set_during_initial_mark_pause();
tonyp@1794: 
tonyp@1794:       // And we can now clear initiate_conc_mark_if_possible() as
tonyp@1794:       // we've already acted on it.
tonyp@1794:       clear_initiate_conc_mark_if_possible();
tonyp@1794:     } else {
tonyp@1794:       // The concurrent marking thread is still finishing up the
tonyp@1794:       // previous cycle. If we start one right now the two cycles
tonyp@1794:       // overlap. In particular, the concurrent marking thread might
tonyp@1794:       // be in the process of clearing the next marking bitmap (which
tonyp@1794:       // we will use for the next cycle if we start one). Starting a
tonyp@1794:       // cycle now will be bad given that parts of the marking
tonyp@1794:       // information might get cleared by the marking thread. And we
tonyp@1794:       // cannot wait for the marking thread to finish the cycle as it
tonyp@1794:       // periodically yields while clearing the next marking bitmap
tonyp@1794:       // and, if it's in a yield point, it's waiting for us to
tonyp@1794:       // finish. So, at this point we will not start a cycle and we'll
tonyp@1794:       // let the concurrent marking thread complete the last one.
tonyp@1794:     }
tonyp@1794:   }
tonyp@1794: }
tonyp@1794: 
tonyp@1794: void
ysr@777: G1CollectorPolicy_BestRegionsFirst::
ysr@777: record_collection_pause_start(double start_time_sec, size_t start_used) {
ysr@777:   G1CollectorPolicy::record_collection_pause_start(start_time_sec, start_used);
ysr@777: }
ysr@777: 
ysr@777: class NextNonCSElemFinder: public HeapRegionClosure {
ysr@777:   HeapRegion* _res;
ysr@777: public:
ysr@777:   NextNonCSElemFinder(): _res(NULL) {}
ysr@777:   bool doHeapRegion(HeapRegion* r) {
ysr@777:     if (!r->in_collection_set()) {
ysr@777:       _res = r;
ysr@777:       return true;
ysr@777:     } else {
ysr@777:       return false;
ysr@777:     }
ysr@777:   }
ysr@777:   HeapRegion* res() { return _res; }
ysr@777: };
ysr@777: 
ysr@777: class KnownGarbageClosure: public HeapRegionClosure {
ysr@777:   CollectionSetChooser* _hrSorted;
ysr@777: 
ysr@777: public:
ysr@777:   KnownGarbageClosure(CollectionSetChooser* hrSorted) :
ysr@777:     _hrSorted(hrSorted)
ysr@777:   {}
ysr@777: 
ysr@777:   bool doHeapRegion(HeapRegion* r) {
ysr@777:     // We only include humongous regions in collection
ysr@777:     // sets when concurrent mark shows that their contained object is
ysr@777:     // unreachable.
ysr@777: 
ysr@777:     // Do we have any marking information for this region?
ysr@777:     if (r->is_marked()) {
ysr@777:       // We don't include humongous regions in collection
ysr@777:       // sets because we collect them immediately at the end of a marking
ysr@777:       // cycle.  We also don't include young regions because we *must*
ysr@777:       // include them in the next collection pause.
ysr@777:       if (!r->isHumongous() && !r->is_young()) {
ysr@777:         _hrSorted->addMarkedHeapRegion(r);
ysr@777:       }
ysr@777:     }
ysr@777:     return false;
ysr@777:   }
ysr@777: };
ysr@777: 
ysr@777: class ParKnownGarbageHRClosure: public HeapRegionClosure {
ysr@777:   CollectionSetChooser* _hrSorted;
ysr@777:   jint _marked_regions_added;
ysr@777:   jint _chunk_size;
ysr@777:   jint _cur_chunk_idx;
ysr@777:   jint _cur_chunk_end; // Cur chunk [_cur_chunk_idx, _cur_chunk_end)
ysr@777:   int _worker;
ysr@777:   int _invokes;
ysr@777: 
ysr@777:   void get_new_chunk() {
ysr@777:     _cur_chunk_idx = _hrSorted->getParMarkedHeapRegionChunk(_chunk_size);
ysr@777:     _cur_chunk_end = _cur_chunk_idx + _chunk_size;
ysr@777:   }
ysr@777:   void add_region(HeapRegion* r) {
ysr@777:     if (_cur_chunk_idx == _cur_chunk_end) {
ysr@777:       get_new_chunk();
ysr@777:     }
ysr@777:     assert(_cur_chunk_idx < _cur_chunk_end, "postcondition");
ysr@777:     _hrSorted->setMarkedHeapRegion(_cur_chunk_idx, r);
ysr@777:     _marked_regions_added++;
ysr@777:     _cur_chunk_idx++;
ysr@777:   }
ysr@777: 
ysr@777: public:
ysr@777:   ParKnownGarbageHRClosure(CollectionSetChooser* hrSorted,
ysr@777:                            jint chunk_size,
ysr@777:                            int worker) :
ysr@777:     _hrSorted(hrSorted), _chunk_size(chunk_size), _worker(worker),
ysr@777:     _marked_regions_added(0), _cur_chunk_idx(0), _cur_chunk_end(0),
ysr@777:     _invokes(0)
ysr@777:   {}
ysr@777: 
ysr@777:   bool doHeapRegion(HeapRegion* r) {
ysr@777:     // We only include humongous regions in collection
ysr@777:     // sets when concurrent mark shows that their contained object is
ysr@777:     // unreachable.
ysr@777:     _invokes++;
ysr@777: 
ysr@777:     // Do we have any marking information for this region?
ysr@777:     if (r->is_marked()) {
ysr@777:       // We don't include humongous regions in collection
ysr@777:       // sets because we collect them immediately at the end of a marking
ysr@777:       // cycle.
ysr@777:       // We also do not include young regions in collection sets
ysr@777:       if (!r->isHumongous() && !r->is_young()) {
ysr@777:         add_region(r);
ysr@777:       }
ysr@777:     }
ysr@777:     return false;
ysr@777:   }
ysr@777:   jint marked_regions_added() { return _marked_regions_added; }
ysr@777:   int invokes() { return _invokes; }
ysr@777: };
ysr@777: 
ysr@777: class ParKnownGarbageTask: public AbstractGangTask {
ysr@777:   CollectionSetChooser* _hrSorted;
ysr@777:   jint _chunk_size;
ysr@777:   G1CollectedHeap* _g1;
ysr@777: public:
ysr@777:   ParKnownGarbageTask(CollectionSetChooser* hrSorted, jint chunk_size) :
ysr@777:     AbstractGangTask("ParKnownGarbageTask"),
ysr@777:     _hrSorted(hrSorted), _chunk_size(chunk_size),
ysr@777:     _g1(G1CollectedHeap::heap())
ysr@777:   {}
ysr@777: 
ysr@777:   void work(int i) {
ysr@777:     ParKnownGarbageHRClosure parKnownGarbageCl(_hrSorted, _chunk_size, i);
ysr@777:     // Back to zero for the claim value.
tonyp@790:     _g1->heap_region_par_iterate_chunked(&parKnownGarbageCl, i,
tonyp@790:                                          HeapRegion::InitialClaimValue);
ysr@777:     jint regions_added = parKnownGarbageCl.marked_regions_added();
ysr@777:     _hrSorted->incNumMarkedHeapRegions(regions_added);
ysr@777:     if (G1PrintParCleanupStats) {
ysr@777:       gclog_or_tty->print("     Thread %d called %d times, added %d regions to list.\n",
ysr@777:                  i, parKnownGarbageCl.invokes(), regions_added);
ysr@777:     }
ysr@777:   }
ysr@777: };
ysr@777: 
ysr@777: void
ysr@777: G1CollectorPolicy_BestRegionsFirst::
ysr@777: record_concurrent_mark_cleanup_end(size_t freed_bytes,
ysr@777:                                    size_t max_live_bytes) {
ysr@777:   double start;
ysr@777:   if (G1PrintParCleanupStats) start = os::elapsedTime();
ysr@777:   record_concurrent_mark_cleanup_end_work1(freed_bytes, max_live_bytes);
ysr@777: 
ysr@777:   _collectionSetChooser->clearMarkedHeapRegions();
ysr@777:   double clear_marked_end;
ysr@777:   if (G1PrintParCleanupStats) {
ysr@777:     clear_marked_end = os::elapsedTime();
ysr@777:     gclog_or_tty->print_cr("  clear marked regions + work1: %8.3f ms.",
ysr@777:                   (clear_marked_end - start)*1000.0);
ysr@777:   }
ysr@777:   if (ParallelGCThreads > 0) {
ysr@777:     const size_t OverpartitionFactor = 4;
kvn@1926:     const size_t MinWorkUnit = 8;
kvn@1926:     const size_t WorkUnit =
ysr@777:       MAX2(_g1->n_regions() / (ParallelGCThreads * OverpartitionFactor),
kvn@1926:            MinWorkUnit);
ysr@777:     _collectionSetChooser->prepareForAddMarkedHeapRegionsPar(_g1->n_regions(),
kvn@1926:                                                              WorkUnit);
ysr@777:     ParKnownGarbageTask parKnownGarbageTask(_collectionSetChooser,
kvn@1926:                                             (int) WorkUnit);
ysr@777:     _g1->workers()->run_task(&parKnownGarbageTask);
tonyp@790: 
tonyp@790:     assert(_g1->check_heap_region_claim_values(HeapRegion::InitialClaimValue),
tonyp@790:            "sanity check");
ysr@777:   } else {
ysr@777:     KnownGarbageClosure knownGarbagecl(_collectionSetChooser);
ysr@777:     _g1->heap_region_iterate(&knownGarbagecl);
ysr@777:   }
ysr@777:   double known_garbage_end;
ysr@777:   if (G1PrintParCleanupStats) {
ysr@777:     known_garbage_end = os::elapsedTime();
ysr@777:     gclog_or_tty->print_cr("  compute known garbage: %8.3f ms.",
ysr@777:                   (known_garbage_end - clear_marked_end)*1000.0);
ysr@777:   }
ysr@777:   _collectionSetChooser->sortMarkedHeapRegions();
ysr@777:   double sort_end;
ysr@777:   if (G1PrintParCleanupStats) {
ysr@777:     sort_end = os::elapsedTime();
ysr@777:     gclog_or_tty->print_cr("  sorting: %8.3f ms.",
ysr@777:                   (sort_end - known_garbage_end)*1000.0);
ysr@777:   }
ysr@777: 
ysr@777:   record_concurrent_mark_cleanup_end_work2();
ysr@777:   double work2_end;
ysr@777:   if (G1PrintParCleanupStats) {
ysr@777:     work2_end = os::elapsedTime();
ysr@777:     gclog_or_tty->print_cr("  work2: %8.3f ms.",
ysr@777:                   (work2_end - sort_end)*1000.0);
ysr@777:   }
ysr@777: }
ysr@777: 
johnc@1829: // Add the heap region at the head of the non-incremental collection set
ysr@777: void G1CollectorPolicy::
ysr@777: add_to_collection_set(HeapRegion* hr) {
johnc@1829:   assert(_inc_cset_build_state == Active, "Precondition");
johnc@1829:   assert(!hr->is_young(), "non-incremental add of young region");
johnc@1829: 
tonyp@1717:   if (G1PrintHeapRegions) {
tonyp@1823:     gclog_or_tty->print_cr("added region to cset "
tonyp@1823:                            "%d:["PTR_FORMAT", "PTR_FORMAT"], "
tonyp@1823:                            "top "PTR_FORMAT", %s",
tonyp@1823:                            hr->hrs_index(), hr->bottom(), hr->end(),
tonyp@1823:                            hr->top(), hr->is_young() ? "YOUNG" : "NOT_YOUNG");
ysr@777:   }
ysr@777: 
ysr@777:   if (_g1->mark_in_progress())
ysr@777:     _g1->concurrent_mark()->registerCSetRegion(hr);
ysr@777: 
johnc@1829:   assert(!hr->in_collection_set(), "should not already be in the CSet");
ysr@777:   hr->set_in_collection_set(true);
ysr@777:   hr->set_next_in_collection_set(_collection_set);
ysr@777:   _collection_set = hr;
ysr@777:   _collection_set_size++;
ysr@777:   _collection_set_bytes_used_before += hr->used();
tonyp@961:   _g1->register_region_with_in_cset_fast_test(hr);
ysr@777: }
ysr@777: 
johnc@1829: // Initialize the per-collection-set information
johnc@1829: void G1CollectorPolicy::start_incremental_cset_building() {
johnc@1829:   assert(_inc_cset_build_state == Inactive, "Precondition");
johnc@1829: 
johnc@1829:   _inc_cset_head = NULL;
johnc@1829:   _inc_cset_tail = NULL;
johnc@1829:   _inc_cset_size = 0;
johnc@1829:   _inc_cset_bytes_used_before = 0;
johnc@1829: 
johnc@1829:   if (in_young_gc_mode()) {
johnc@1829:     _inc_cset_young_index = 0;
johnc@1829:   }
johnc@1829: 
johnc@1829:   _inc_cset_max_finger = 0;
johnc@1829:   _inc_cset_recorded_young_bytes = 0;
johnc@1829:   _inc_cset_recorded_rs_lengths = 0;
johnc@1829:   _inc_cset_predicted_elapsed_time_ms = 0;
johnc@1829:   _inc_cset_predicted_bytes_to_copy = 0;
johnc@1829:   _inc_cset_build_state = Active;
johnc@1829: }
johnc@1829: 
johnc@1829: void G1CollectorPolicy::add_to_incremental_cset_info(HeapRegion* hr, size_t rs_length) {
johnc@1829:   // This routine is used when:
johnc@1829:   // * adding survivor regions to the incremental cset at the end of an
johnc@1829:   //   evacuation pause,
johnc@1829:   // * adding the current allocation region to the incremental cset
johnc@1829:   //   when it is retired, and
johnc@1829:   // * updating existing policy information for a region in the
johnc@1829:   //   incremental cset via young list RSet sampling.
johnc@1829:   // Therefore this routine may be called at a safepoint by the
johnc@1829:   // VM thread, or in-between safepoints by mutator threads (when
johnc@1829:   // retiring the current allocation region) or a concurrent
johnc@1829:   // refine thread (RSet sampling).
johnc@1829: 
johnc@1829:   double region_elapsed_time_ms = predict_region_elapsed_time_ms(hr, true);
johnc@1829:   size_t used_bytes = hr->used();
johnc@1829: 
johnc@1829:   _inc_cset_recorded_rs_lengths += rs_length;
johnc@1829:   _inc_cset_predicted_elapsed_time_ms += region_elapsed_time_ms;
johnc@1829: 
johnc@1829:   _inc_cset_bytes_used_before += used_bytes;
johnc@1829: 
johnc@1829:   // Cache the values we have added to the aggregated informtion
johnc@1829:   // in the heap region in case we have to remove this region from
johnc@1829:   // the incremental collection set, or it is updated by the
johnc@1829:   // rset sampling code
johnc@1829:   hr->set_recorded_rs_length(rs_length);
johnc@1829:   hr->set_predicted_elapsed_time_ms(region_elapsed_time_ms);
johnc@1829: 
johnc@1829: #if PREDICTIONS_VERBOSE
johnc@1829:   size_t bytes_to_copy = predict_bytes_to_copy(hr);
johnc@1829:   _inc_cset_predicted_bytes_to_copy += bytes_to_copy;
johnc@1829: 
johnc@1829:   // Record the number of bytes used in this region
johnc@1829:   _inc_cset_recorded_young_bytes += used_bytes;
johnc@1829: 
johnc@1829:   // Cache the values we have added to the aggregated informtion
johnc@1829:   // in the heap region in case we have to remove this region from
johnc@1829:   // the incremental collection set, or it is updated by the
johnc@1829:   // rset sampling code
johnc@1829:   hr->set_predicted_bytes_to_copy(bytes_to_copy);
johnc@1829: #endif // PREDICTIONS_VERBOSE
johnc@1829: }
johnc@1829: 
johnc@1829: void G1CollectorPolicy::remove_from_incremental_cset_info(HeapRegion* hr) {
johnc@1829:   // This routine is currently only called as part of the updating of
johnc@1829:   // existing policy information for regions in the incremental cset that
johnc@1829:   // is performed by the concurrent refine thread(s) as part of young list
johnc@1829:   // RSet sampling. Therefore we should not be at a safepoint.
johnc@1829: 
johnc@1829:   assert(!SafepointSynchronize::is_at_safepoint(), "should not be at safepoint");
johnc@1829:   assert(hr->is_young(), "it should be");
johnc@1829: 
johnc@1829:   size_t used_bytes = hr->used();
johnc@1829:   size_t old_rs_length = hr->recorded_rs_length();
johnc@1829:   double old_elapsed_time_ms = hr->predicted_elapsed_time_ms();
johnc@1829: 
johnc@1829:   // Subtract the old recorded/predicted policy information for
johnc@1829:   // the given heap region from the collection set info.
johnc@1829:   _inc_cset_recorded_rs_lengths -= old_rs_length;
johnc@1829:   _inc_cset_predicted_elapsed_time_ms -= old_elapsed_time_ms;
johnc@1829: 
johnc@1829:   _inc_cset_bytes_used_before -= used_bytes;
johnc@1829: 
johnc@1829:   // Clear the values cached in the heap region
johnc@1829:   hr->set_recorded_rs_length(0);
johnc@1829:   hr->set_predicted_elapsed_time_ms(0);
johnc@1829: 
johnc@1829: #if PREDICTIONS_VERBOSE
johnc@1829:   size_t old_predicted_bytes_to_copy = hr->predicted_bytes_to_copy();
johnc@1829:   _inc_cset_predicted_bytes_to_copy -= old_predicted_bytes_to_copy;
johnc@1829: 
johnc@1829:   // Subtract the number of bytes used in this region
johnc@1829:   _inc_cset_recorded_young_bytes -= used_bytes;
johnc@1829: 
johnc@1829:   // Clear the values cached in the heap region
johnc@1829:   hr->set_predicted_bytes_to_copy(0);
johnc@1829: #endif // PREDICTIONS_VERBOSE
johnc@1829: }
johnc@1829: 
johnc@1829: void G1CollectorPolicy::update_incremental_cset_info(HeapRegion* hr, size_t new_rs_length) {
johnc@1829:   // Update the collection set information that is dependent on the new RS length
johnc@1829:   assert(hr->is_young(), "Precondition");
johnc@1829: 
johnc@1829:   remove_from_incremental_cset_info(hr);
johnc@1829:   add_to_incremental_cset_info(hr, new_rs_length);
johnc@1829: }
johnc@1829: 
johnc@1829: void G1CollectorPolicy::add_region_to_incremental_cset_common(HeapRegion* hr) {
johnc@1829:   assert( hr->is_young(), "invariant");
johnc@1829:   assert( hr->young_index_in_cset() == -1, "invariant" );
johnc@1829:   assert(_inc_cset_build_state == Active, "Precondition");
johnc@1829: 
johnc@1829:   // We need to clear and set the cached recorded/cached collection set
johnc@1829:   // information in the heap region here (before the region gets added
johnc@1829:   // to the collection set). An individual heap region's cached values
johnc@1829:   // are calculated, aggregated with the policy collection set info,
johnc@1829:   // and cached in the heap region here (initially) and (subsequently)
johnc@1829:   // by the Young List sampling code.
johnc@1829: 
johnc@1829:   size_t rs_length = hr->rem_set()->occupied();
johnc@1829:   add_to_incremental_cset_info(hr, rs_length);
johnc@1829: 
johnc@1829:   HeapWord* hr_end = hr->end();
johnc@1829:   _inc_cset_max_finger = MAX2(_inc_cset_max_finger, hr_end);
johnc@1829: 
johnc@1829:   assert(!hr->in_collection_set(), "invariant");
johnc@1829:   hr->set_in_collection_set(true);
johnc@1829:   assert( hr->next_in_collection_set() == NULL, "invariant");
johnc@1829: 
johnc@1829:   _inc_cset_size++;
johnc@1829:   _g1->register_region_with_in_cset_fast_test(hr);
johnc@1829: 
johnc@1829:   hr->set_young_index_in_cset((int) _inc_cset_young_index);
johnc@1829:   ++_inc_cset_young_index;
johnc@1829: }
johnc@1829: 
johnc@1829: // Add the region at the RHS of the incremental cset
johnc@1829: void G1CollectorPolicy::add_region_to_incremental_cset_rhs(HeapRegion* hr) {
johnc@1829:   // We should only ever be appending survivors at the end of a pause
johnc@1829:   assert( hr->is_survivor(), "Logic");
johnc@1829: 
johnc@1829:   // Do the 'common' stuff
johnc@1829:   add_region_to_incremental_cset_common(hr);
johnc@1829: 
johnc@1829:   // Now add the region at the right hand side
johnc@1829:   if (_inc_cset_tail == NULL) {
johnc@1829:     assert(_inc_cset_head == NULL, "invariant");
johnc@1829:     _inc_cset_head = hr;
johnc@1829:   } else {
johnc@1829:     _inc_cset_tail->set_next_in_collection_set(hr);
johnc@1829:   }
johnc@1829:   _inc_cset_tail = hr;
johnc@1829: 
johnc@1829:   if (G1PrintHeapRegions) {
johnc@1829:     gclog_or_tty->print_cr(" added region to incremental cset (RHS) "
johnc@1829:                   "%d:["PTR_FORMAT", "PTR_FORMAT"], "
johnc@1829:                   "top "PTR_FORMAT", young %s",
johnc@1829:                   hr->hrs_index(), hr->bottom(), hr->end(),
johnc@1829:                   hr->top(), (hr->is_young()) ? "YES" : "NO");
johnc@1829:   }
johnc@1829: }
johnc@1829: 
johnc@1829: // Add the region to the LHS of the incremental cset
johnc@1829: void G1CollectorPolicy::add_region_to_incremental_cset_lhs(HeapRegion* hr) {
johnc@1829:   // Survivors should be added to the RHS at the end of a pause
johnc@1829:   assert(!hr->is_survivor(), "Logic");
johnc@1829: 
johnc@1829:   // Do the 'common' stuff
johnc@1829:   add_region_to_incremental_cset_common(hr);
johnc@1829: 
johnc@1829:   // Add the region at the left hand side
johnc@1829:   hr->set_next_in_collection_set(_inc_cset_head);
johnc@1829:   if (_inc_cset_head == NULL) {
johnc@1829:     assert(_inc_cset_tail == NULL, "Invariant");
johnc@1829:     _inc_cset_tail = hr;
johnc@1829:   }
johnc@1829:   _inc_cset_head = hr;
johnc@1829: 
johnc@1829:   if (G1PrintHeapRegions) {
johnc@1829:     gclog_or_tty->print_cr(" added region to incremental cset (LHS) "
johnc@1829:                   "%d:["PTR_FORMAT", "PTR_FORMAT"], "
johnc@1829:                   "top "PTR_FORMAT", young %s",
johnc@1829:                   hr->hrs_index(), hr->bottom(), hr->end(),
johnc@1829:                   hr->top(), (hr->is_young()) ? "YES" : "NO");
johnc@1829:   }
johnc@1829: }
johnc@1829: 
johnc@1829: #ifndef PRODUCT
johnc@1829: void G1CollectorPolicy::print_collection_set(HeapRegion* list_head, outputStream* st) {
johnc@1829:   assert(list_head == inc_cset_head() || list_head == collection_set(), "must be");
johnc@1829: 
johnc@1829:   st->print_cr("\nCollection_set:");
johnc@1829:   HeapRegion* csr = list_head;
johnc@1829:   while (csr != NULL) {
johnc@1829:     HeapRegion* next = csr->next_in_collection_set();
johnc@1829:     assert(csr->in_collection_set(), "bad CS");
johnc@1829:     st->print_cr("  [%08x-%08x], t: %08x, P: %08x, N: %08x, C: %08x, "
johnc@1829:                  "age: %4d, y: %d, surv: %d",
johnc@1829:                         csr->bottom(), csr->end(),
johnc@1829:                         csr->top(),
johnc@1829:                         csr->prev_top_at_mark_start(),
johnc@1829:                         csr->next_top_at_mark_start(),
johnc@1829:                         csr->top_at_conc_mark_count(),
johnc@1829:                         csr->age_in_surv_rate_group_cond(),
johnc@1829:                         csr->is_young(),
johnc@1829:                         csr->is_survivor());
johnc@1829:     csr = next;
johnc@1829:   }
johnc@1829: }
johnc@1829: #endif // !PRODUCT
johnc@1829: 
johnc@1829: bool
tonyp@2011: G1CollectorPolicy_BestRegionsFirst::choose_collection_set(
tonyp@2011:                                                   double target_pause_time_ms) {
johnc@1829:   // Set this here - in case we're not doing young collections.
johnc@1829:   double non_young_start_time_sec = os::elapsedTime();
johnc@1829: 
johnc@1829:   // The result that this routine will return. This will be set to
johnc@1829:   // false if:
johnc@1829:   // * we're doing a young or partially young collection and we
johnc@1829:   //   have added the youg regions to collection set, or
johnc@1829:   // * we add old regions to the collection set.
johnc@1829:   bool abandon_collection = true;
johnc@1829: 
ysr@777:   start_recording_regions();
ysr@777: 
tonyp@2011:   guarantee(target_pause_time_ms > 0.0,
tonyp@2011:             err_msg("target_pause_time_ms = %1.6lf should be positive",
tonyp@2011:                     target_pause_time_ms));
tonyp@2011:   guarantee(_collection_set == NULL, "Precondition");
ysr@777: 
ysr@777:   double base_time_ms = predict_base_elapsed_time_ms(_pending_cards);
ysr@777:   double predicted_pause_time_ms = base_time_ms;
ysr@777: 
tonyp@2011:   double time_remaining_ms = target_pause_time_ms - base_time_ms;
ysr@777: 
ysr@777:   // the 10% and 50% values are arbitrary...
tonyp@2011:   if (time_remaining_ms < 0.10 * target_pause_time_ms) {
tonyp@2011:     time_remaining_ms = 0.50 * target_pause_time_ms;
ysr@777:     _within_target = false;
ysr@777:   } else {
ysr@777:     _within_target = true;
ysr@777:   }
ysr@777: 
ysr@777:   // We figure out the number of bytes available for future to-space.
ysr@777:   // For new regions without marking information, we must assume the
ysr@777:   // worst-case of complete survival.  If we have marking information for a
ysr@777:   // region, we can bound the amount of live data.  We can add a number of
ysr@777:   // such regions, as long as the sum of the live data bounds does not
ysr@777:   // exceed the available evacuation space.
ysr@777:   size_t max_live_bytes = _g1->free_regions() * HeapRegion::GrainBytes;
ysr@777: 
ysr@777:   size_t expansion_bytes =
ysr@777:     _g1->expansion_regions() * HeapRegion::GrainBytes;
ysr@777: 
apetrusenko@1112:   _collection_set_bytes_used_before = 0;
apetrusenko@1112:   _collection_set_size = 0;
ysr@777: 
ysr@777:   // Adjust for expansion and slop.
ysr@777:   max_live_bytes = max_live_bytes + expansion_bytes;
ysr@777: 
apetrusenko@1112:   assert(_g1->regions_accounted_for(), "Region leakage!");
ysr@777: 
ysr@777:   HeapRegion* hr;
ysr@777:   if (in_young_gc_mode()) {
ysr@777:     double young_start_time_sec = os::elapsedTime();
ysr@777: 
ysr@777:     if (G1PolicyVerbose > 0) {
ysr@777:       gclog_or_tty->print_cr("Adding %d young regions to the CSet",
johnc@1829:                     _g1->young_list()->length());
ysr@777:     }
johnc@1829: 
ysr@777:     _young_cset_length  = 0;
ysr@777:     _last_young_gc_full = full_young_gcs() ? true : false;
johnc@1829: 
ysr@777:     if (_last_young_gc_full)
ysr@777:       ++_full_young_pause_num;
ysr@777:     else
ysr@777:       ++_partial_young_pause_num;
johnc@1829: 
johnc@1829:     // The young list is laid with the survivor regions from the previous
johnc@1829:     // pause are appended to the RHS of the young list, i.e.
johnc@1829:     //   [Newly Young Regions ++ Survivors from last pause].
johnc@1829: 
johnc@1829:     hr = _g1->young_list()->first_survivor_region();
ysr@777:     while (hr != NULL) {
johnc@1829:       assert(hr->is_survivor(), "badly formed young list");
johnc@1829:       hr->set_young();
johnc@1829:       hr = hr->get_next_young_region();
ysr@777:     }
ysr@777: 
johnc@1829:     // Clear the fields that point to the survivor list - they are
johnc@1829:     // all young now.
johnc@1829:     _g1->young_list()->clear_survivors();
johnc@1829: 
johnc@1829:     if (_g1->mark_in_progress())
johnc@1829:       _g1->concurrent_mark()->register_collection_set_finger(_inc_cset_max_finger);
johnc@1829: 
johnc@1829:     _young_cset_length = _inc_cset_young_index;
johnc@1829:     _collection_set = _inc_cset_head;
johnc@1829:     _collection_set_size = _inc_cset_size;
johnc@1829:     _collection_set_bytes_used_before = _inc_cset_bytes_used_before;
johnc@1829: 
johnc@1829:     // For young regions in the collection set, we assume the worst
johnc@1829:     // case of complete survival
johnc@1829:     max_live_bytes -= _inc_cset_size * HeapRegion::GrainBytes;
johnc@1829: 
johnc@1829:     time_remaining_ms -= _inc_cset_predicted_elapsed_time_ms;
johnc@1829:     predicted_pause_time_ms += _inc_cset_predicted_elapsed_time_ms;
johnc@1829: 
johnc@1829:     // The number of recorded young regions is the incremental
johnc@1829:     // collection set's current size
johnc@1829:     set_recorded_young_regions(_inc_cset_size);
johnc@1829:     set_recorded_rs_lengths(_inc_cset_recorded_rs_lengths);
johnc@1829:     set_recorded_young_bytes(_inc_cset_recorded_young_bytes);
johnc@1829: #if PREDICTIONS_VERBOSE
johnc@1829:     set_predicted_bytes_to_copy(_inc_cset_predicted_bytes_to_copy);
johnc@1829: #endif // PREDICTIONS_VERBOSE
johnc@1829: 
johnc@1829:     if (G1PolicyVerbose > 0) {
johnc@1829:       gclog_or_tty->print_cr("  Added " PTR_FORMAT " Young Regions to CS.",
johnc@1829:                              _inc_cset_size);
johnc@1829:       gclog_or_tty->print_cr("    (" SIZE_FORMAT " KB left in heap.)",
johnc@1829:                             max_live_bytes/K);
johnc@1829:     }
johnc@1829: 
johnc@1829:     assert(_inc_cset_size == _g1->young_list()->length(), "Invariant");
johnc@1829:     if (_inc_cset_size > 0) {
johnc@1829:       assert(_collection_set != NULL, "Invariant");
johnc@1829:       abandon_collection = false;
johnc@1829:     }
ysr@777: 
ysr@777:     double young_end_time_sec = os::elapsedTime();
ysr@777:     _recorded_young_cset_choice_time_ms =
ysr@777:       (young_end_time_sec - young_start_time_sec) * 1000.0;
ysr@777: 
johnc@1829:     // We are doing young collections so reset this.
johnc@1829:     non_young_start_time_sec = young_end_time_sec;
johnc@1829: 
johnc@1829:     // Note we can use either _collection_set_size or
johnc@1829:     // _young_cset_length here
johnc@1829:     if (_collection_set_size > 0 && _last_young_gc_full) {
ysr@777:       // don't bother adding more regions...
ysr@777:       goto choose_collection_set_end;
ysr@777:     }
ysr@777:   }
ysr@777: 
ysr@777:   if (!in_young_gc_mode() || !full_young_gcs()) {
ysr@777:     bool should_continue = true;
ysr@777:     NumberSeq seq;
ysr@777:     double avg_prediction = 100000000000000000.0; // something very large
johnc@1829: 
johnc@1829:     // Save the current size of the collection set to detect
johnc@1829:     // if we actually added any old regions.
johnc@1829:     size_t n_young_regions = _collection_set_size;
johnc@1829: 
ysr@777:     do {
ysr@777:       hr = _collectionSetChooser->getNextMarkedRegion(time_remaining_ms,
ysr@777:                                                       avg_prediction);
apetrusenko@1112:       if (hr != NULL) {
ysr@777:         double predicted_time_ms = predict_region_elapsed_time_ms(hr, false);
ysr@777:         time_remaining_ms -= predicted_time_ms;
ysr@777:         predicted_pause_time_ms += predicted_time_ms;
ysr@777:         add_to_collection_set(hr);
johnc@1829:         record_non_young_cset_region(hr);
ysr@777:         max_live_bytes -= MIN2(hr->max_live_bytes(), max_live_bytes);
ysr@777:         if (G1PolicyVerbose > 0) {
ysr@777:           gclog_or_tty->print_cr("    (" SIZE_FORMAT " KB left in heap.)",
ysr@777:                         max_live_bytes/K);
ysr@777:         }
ysr@777:         seq.add(predicted_time_ms);
ysr@777:         avg_prediction = seq.avg() + seq.sd();
ysr@777:       }
ysr@777:       should_continue =
ysr@777:         ( hr != NULL) &&
ysr@777:         ( (adaptive_young_list_length()) ? time_remaining_ms > 0.0
ysr@777:           : _collection_set_size < _young_list_fixed_length );
ysr@777:     } while (should_continue);
ysr@777: 
ysr@777:     if (!adaptive_young_list_length() &&
ysr@777:         _collection_set_size < _young_list_fixed_length)
ysr@777:       _should_revert_to_full_young_gcs  = true;
johnc@1829: 
johnc@1829:     if (_collection_set_size > n_young_regions) {
johnc@1829:       // We actually added old regions to the collection set
johnc@1829:       // so we are not abandoning this collection.
johnc@1829:       abandon_collection = false;
johnc@1829:     }
ysr@777:   }
ysr@777: 
ysr@777: choose_collection_set_end:
johnc@1829:   stop_incremental_cset_building();
johnc@1829: 
ysr@777:   count_CS_bytes_used();
ysr@777: 
ysr@777:   end_recording_regions();
ysr@777: 
ysr@777:   double non_young_end_time_sec = os::elapsedTime();
ysr@777:   _recorded_non_young_cset_choice_time_ms =
ysr@777:     (non_young_end_time_sec - non_young_start_time_sec) * 1000.0;
johnc@1829: 
tonyp@2011:   // Here we are supposed to return whether the pause should be
tonyp@2011:   // abandoned or not (i.e., whether the collection set is empty or
tonyp@2011:   // not). However, this introduces a subtle issue when a pause is
tonyp@2011:   // initiated explicitly with System.gc() and
tonyp@2011:   // +ExplicitGCInvokesConcurrent (see Comment #2 in CR 6944166), it's
tonyp@2011:   // supposed to start a marking cycle, and it's abandoned. So, by
tonyp@2011:   // returning false here we are telling the caller never to consider
tonyp@2011:   // a pause to be abandoned. We'll actually remove all the code
tonyp@2011:   // associated with abandoned pauses as part of CR 6963209, but we are
tonyp@2011:   // just disabling them this way for the moment to avoid increasing
tonyp@2011:   // further the amount of changes for CR 6944166.
tonyp@2011:   return false;
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy_BestRegionsFirst::record_full_collection_end() {
ysr@777:   G1CollectorPolicy::record_full_collection_end();
ysr@777:   _collectionSetChooser->updateAfterFullCollection();
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy_BestRegionsFirst::
ysr@777: expand_if_possible(size_t numRegions) {
ysr@777:   size_t expansion_bytes = numRegions * HeapRegion::GrainBytes;
ysr@777:   _g1->expand(expansion_bytes);
ysr@777: }
ysr@777: 
ysr@777: void G1CollectorPolicy_BestRegionsFirst::
apetrusenko@1112: record_collection_pause_end(bool abandoned) {
apetrusenko@1112:   G1CollectorPolicy::record_collection_pause_end(abandoned);
ysr@777:   assert(assertMarkedBytesDataOK(), "Marked regions not OK at pause end.");
ysr@777: }