builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-024 starttime: 1488125702.47 results: success (0) revision: 4d497454ce0c0e1c6f3339c1e1a17528e894d7ce ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:02.468859) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:02.469234) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:02.469495) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:02.481616) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:02.481908) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-02-26 08:15:02-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 55.0M=0s 2017-02-26 08:15:02 (55.0 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.199110 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:02.691888) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:02.692188) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015293 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:02.742518) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:02.742846) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 4d497454ce0c0e1c6f3339c1e1a17528e894d7ce --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 4d497454ce0c0e1c6f3339c1e1a17528e894d7ce --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-02-26 08:15:02,966 truncating revision to first 12 chars 2017-02-26 08:15:02,967 Setting DEBUG logging. 2017-02-26 08:15:02,967 attempt 1/10 2017-02-26 08:15:02,967 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/4d497454ce0c?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-02-26 08:15:03,543 unpacking tar archive at: mozilla-aurora-4d497454ce0c/testing/mozharness/ program finished with exit code 0 elapsedTime=0.891190 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:03.646487) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:03.646801) ========= script_repo_revision: 4d497454ce0c0e1c6f3339c1e1a17528e894d7ce ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:03.647163) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:03.647417) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-26 08:15:03.656037) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2017-02-26 08:15:03.656308) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:15:03 INFO - MultiFileLogger online at 20170226 08:15:03 in /builds/slave/test 08:15:03 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 08:15:03 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:15:03 INFO - {'append_to_log': False, 08:15:03 INFO - 'base_work_dir': '/builds/slave/test', 08:15:03 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 08:15:03 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:15:03 INFO - 'branch': 'Mozilla-Aurora', 08:15:03 INFO - 'buildbot_json_path': 'buildprops.json', 08:15:03 INFO - 'config_files': ('talos/linux_config.py',), 08:15:03 INFO - 'default_actions': ('clobber', 08:15:03 INFO - 'read-buildbot-config', 08:15:03 INFO - 'download-and-extract', 08:15:03 INFO - 'populate-webroot', 08:15:03 INFO - 'create-virtualenv', 08:15:03 INFO - 'install', 08:15:03 INFO - 'run-tests'), 08:15:03 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:15:03 INFO - 'download_minidump_stackwalk': True, 08:15:03 INFO - 'download_symbols': 'ondemand', 08:15:03 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:15:03 INFO - 'tooltool.py': '/tools/tooltool.py', 08:15:03 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:15:03 INFO - '/tools/misc-python/virtualenv.py')}, 08:15:03 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:15:03 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:15:03 INFO - 'installer_path': 'installer.exe', 08:15:03 INFO - 'log_level': 'info', 08:15:03 INFO - 'log_name': 'talos', 08:15:03 INFO - 'log_to_console': True, 08:15:03 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:15:03 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:15:03 INFO - 'opt_config_files': (), 08:15:03 INFO - 'pip_index': False, 08:15:03 INFO - 'sps_profile': False, 08:15:03 INFO - 'sps_profile_interval': 0, 08:15:03 INFO - 'suite': 'dromaeojs', 08:15:03 INFO - 'system_bits': '32', 08:15:03 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:15:03 INFO - 'title': 'talos-linux64-ix-024', 08:15:03 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:15:03 INFO - 'use_talos_json': True, 08:15:03 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:15:03 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:15:03 INFO - 'work_dir': 'build'} 08:15:03 INFO - [mozharness: 2017-02-26 16:15:03.976172Z] Running clobber step. 08:15:03 INFO - Running pre-action listener: _resource_record_pre_action 08:15:03 INFO - Running main action method: clobber 08:15:03 INFO - rmtree: /builds/slave/test/build 08:15:03 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:15:04 INFO - Running post-action listener: _resource_record_post_action 08:15:04 INFO - [mozharness: 2017-02-26 16:15:04.880023Z] Finished clobber step (success) 08:15:04 INFO - [mozharness: 2017-02-26 16:15:04.880124Z] Running read-buildbot-config step. 08:15:04 INFO - Running pre-action listener: _resource_record_pre_action 08:15:04 INFO - Running main action method: read_buildbot_config 08:15:04 INFO - Using buildbot properties: 08:15:04 INFO - { 08:15:04 INFO - "project": "", 08:15:04 INFO - "product": "firefox", 08:15:04 INFO - "who": "ffxbld@noreply.mozilla.org", 08:15:04 INFO - "installer_path": "public/build/target.tar.bz2", 08:15:04 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 08:15:04 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-aurora/", 08:15:04 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 08:15:04 INFO - "stage_platform": "linux64-pgo", 08:15:04 INFO - "basedir": "/builds/slave/test", 08:15:04 INFO - "buildnumber": 796, 08:15:04 INFO - "platform": "ubuntu64_hw", 08:15:04 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 08:15:04 INFO - "slavebuilddir": "test", 08:15:04 INFO - "taskId": "ZNNgJYP8QpS3rupefH3cMA", 08:15:04 INFO - "branch": "mozilla-aurora", 08:15:04 INFO - "script_repo_revision": "production", 08:15:04 INFO - "revision": "4d497454ce0c0e1c6f3339c1e1a17528e894d7ce", 08:15:04 INFO - "slavename": "talos-linux64-ix-024", 08:15:04 INFO - "repo_path": "releases/mozilla-aurora" 08:15:04 INFO - } 08:15:04 INFO - Finding installer, test and symbols from parent task. 08:15:04 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZNNgJYP8QpS3rupefH3cMA'}, attempt #1 08:15:05 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ZNNgJYP8QpS3rupefH3cMA'}, attempt #1 08:15:05 INFO - Task dependencies: EjcYdpQETZ68Oa26pv8O7Q 08:15:05 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q'}, attempt #1 08:15:06 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.tar.bz2 08:15:06 INFO - Set test_url: https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/test_packages.json 08:15:06 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.crashreporter-symbols.zip 08:15:06 INFO - Running post-action listener: _resource_record_post_action 08:15:06 INFO - [mozharness: 2017-02-26 16:15:06.263814Z] Finished read-buildbot-config step (success) 08:15:06 INFO - [mozharness: 2017-02-26 16:15:06.264035Z] Running download-and-extract step. 08:15:06 INFO - Running pre-action listener: _resource_record_pre_action 08:15:06 INFO - Running main action method: download_and_extract 08:15:06 INFO - mkdir: /builds/slave/test/build/tests 08:15:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:06 INFO - trying https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.test_packages.json 08:15:06 INFO - Downloading https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 08:15:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 08:15:06 INFO - Downloaded 896 bytes. 08:15:06 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 08:15:06 INFO - Using the following test package requirements: 08:15:06 INFO - {u'common': [u'target.common.tests.zip'], 08:15:06 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 08:15:06 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 08:15:06 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 08:15:06 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 08:15:06 INFO - u'mozbase': [u'target.common.tests.zip'], 08:15:06 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 08:15:06 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 08:15:06 INFO - u'web-platform': [u'target.common.tests.zip', 08:15:06 INFO - u'target.web-platform.tests.zip'], 08:15:06 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 08:15:06 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 08:15:06 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.common.tests.zip 08:15:06 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:15:06 INFO - Fetch https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.common.tests.zip into memory 08:15:07 INFO - Expected file size: 21865095 08:15:07 INFO - Obtained file size: 21865095 08:15:11 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 08:15:11 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.common.tests.zip 08:15:11 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.common.tests.zip'}, attempt #1 08:15:11 INFO - Fetch https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.common.tests.zip into memory 08:15:12 INFO - Expected file size: 21865095 08:15:12 INFO - Obtained file size: 21865095 08:15:17 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.talos.tests.zip 08:15:17 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.talos.tests.zip'}, attempt #1 08:15:17 INFO - Fetch https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.talos.tests.zip into memory 08:15:17 INFO - Expected file size: 14403472 08:15:17 INFO - Obtained file size: 14403472 08:15:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:17 INFO - trying https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.tar.bz2 08:15:17 INFO - Downloading https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 08:15:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 08:15:19 INFO - Downloaded 66189349 bytes. 08:15:19 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.tar.bz2 08:15:19 INFO - mkdir: /builds/slave/test/properties 08:15:19 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:15:19 INFO - Writing to file /builds/slave/test/properties/build_url 08:15:19 INFO - Contents: 08:15:19 INFO - build_url:https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.tar.bz2 08:15:19 INFO - Running post-action listener: _resource_record_post_action 08:15:19 INFO - Running post-action listener: set_extra_try_arguments 08:15:19 INFO - [mozharness: 2017-02-26 16:15:19.157658Z] Finished download-and-extract step (success) 08:15:19 INFO - [mozharness: 2017-02-26 16:15:19.157777Z] Running populate-webroot step. 08:15:19 INFO - Running pre-action listener: _resource_record_pre_action 08:15:19 INFO - Running main action method: populate_webroot 08:15:19 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:15:19 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:15:19 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:15:19 INFO - '--tppagecycles', 08:15:19 INFO - '7'], 08:15:19 INFO - 'tests': ['tsvgm']}}, 08:15:19 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:15:19 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:15:19 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:15:19 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:15:19 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:15:19 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:15:19 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 08:15:19 INFO - 'talos_options': ['--disable-e10s'], 08:15:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:15:19 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 08:15:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:15:19 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 08:15:19 INFO - 'talos_options': ['--disable-e10s'], 08:15:19 INFO - 'tests': ['damp', 'tps']}, 08:15:19 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 08:15:19 INFO - 'tests': ['damp', 'tps']}, 08:15:19 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:15:19 INFO - 'tests': ['dromaeo_dom']}, 08:15:19 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:15:19 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:15:19 INFO - 'tests': ['basic_compositor_video']}, 08:15:19 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:15:19 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:15:19 INFO - 'tests': ['a11yr', 08:15:19 INFO - 'ts_paint', 08:15:19 INFO - 'tpaint', 08:15:19 INFO - 'sessionrestore', 08:15:19 INFO - 'sessionrestore_no_auto_restore', 08:15:19 INFO - 'tabpaint']}, 08:15:19 INFO - 'other-e10s': {'tests': ['a11yr', 08:15:19 INFO - 'ts_paint', 08:15:19 INFO - 'tpaint', 08:15:19 INFO - 'sessionrestore', 08:15:19 INFO - 'sessionrestore_no_auto_restore', 08:15:19 INFO - 'tabpaint']}, 08:15:19 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:15:19 INFO - 'ts_paint', 08:15:19 INFO - 'tpaint', 08:15:19 INFO - 'sessionrestore', 08:15:19 INFO - 'sessionrestore_no_auto_restore', 08:15:19 INFO - 'tabpaint']}, 08:15:19 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:15:19 INFO - 'ts_paint', 08:15:19 INFO - 'tpaint', 08:15:19 INFO - 'sessionrestore', 08:15:19 INFO - 'sessionrestore_no_auto_restore', 08:15:19 INFO - 'tabpaint']}, 08:15:19 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:15:19 INFO - 'tests': ['a11yr', 08:15:19 INFO - 'ts_paint', 08:15:19 INFO - 'tpaint', 08:15:19 INFO - 'sessionrestore', 08:15:19 INFO - 'sessionrestore_no_auto_restore', 08:15:19 INFO - 'tabpaint']}, 08:15:19 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:15:19 INFO - 'tests': ['a11yr', 08:15:19 INFO - 'ts_paint', 08:15:19 INFO - 'tpaint', 08:15:19 INFO - 'sessionrestore', 08:15:19 INFO - 'sessionrestore_no_auto_restore', 08:15:19 INFO - 'tabpaint']}, 08:15:19 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:15:19 INFO - 'tests': ['tsvgx', 08:15:19 INFO - 'tsvgr_opacity', 08:15:19 INFO - 'tart', 08:15:19 INFO - 'tscrollx', 08:15:19 INFO - 'cart', 08:15:19 INFO - 'tsvg_static']}, 08:15:19 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:15:19 INFO - 'tsvgr_opacity', 08:15:19 INFO - 'tart', 08:15:19 INFO - 'tscrollx', 08:15:19 INFO - 'cart', 08:15:19 INFO - 'tsvg_static']}, 08:15:19 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 08:15:19 INFO - 'talos_options': ['--disable-e10s'], 08:15:19 INFO - 'tests': ['tp5o']}, 08:15:19 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 08:15:19 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 08:15:19 INFO - 'talos_options': ['--disable-e10s', 08:15:19 INFO - '--xperf_path', 08:15:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:15:19 INFO - 'tests': ['tp5n']}, 08:15:19 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 08:15:19 INFO - 'talos_options': ['--xperf_path', 08:15:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:15:19 INFO - 'tests': ['tp5n']}}, 08:15:19 INFO - 'talos.zip': {'path': '', 08:15:19 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:15:19 INFO - Running post-action listener: _resource_record_post_action 08:15:19 INFO - [mozharness: 2017-02-26 16:15:19.170958Z] Finished populate-webroot step (success) 08:15:19 INFO - [mozharness: 2017-02-26 16:15:19.171048Z] Running create-virtualenv step. 08:15:19 INFO - Running pre-action listener: _resource_record_pre_action 08:15:19 INFO - Running main action method: create_virtualenv 08:15:19 INFO - Creating virtualenv /builds/slave/test/build/venv 08:15:19 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 08:15:19 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:15:19 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:15:19 INFO - Using real prefix '/usr' 08:15:19 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:15:19 INFO - Installing distribute.............................................................................................................................................................................................done. 08:15:21 INFO - Installing pip.................done. 08:15:21 INFO - Return code: 0 08:15:21 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 08:15:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 08:15:21 INFO - Reading from file tmpfile_stdout 08:15:21 INFO - Output received: 08:15:21 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 08:15:21 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:15:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:15:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:15:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:21 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b161f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c26a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e88630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f11850>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e866d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e86b60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:15:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 08:15:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 08:15:21 INFO - Using env: {'DISPLAY': ':0', 08:15:21 INFO - 'HOME': '/home/cltbld', 08:15:21 INFO - 'LANG': 'en_US.UTF-8', 08:15:21 INFO - 'LANGUAGE': 'en_US:en', 08:15:21 INFO - 'LOGNAME': 'cltbld', 08:15:21 INFO - 'MAIL': '/var/mail/cltbld', 08:15:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:15:21 INFO - 'MOZ_NO_REMOTE': '1', 08:15:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:15:21 INFO - 'NO_EM_RESTART': '1', 08:15:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:15:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:15:21 INFO - 'PWD': '/builds/slave/test', 08:15:21 INFO - 'SHELL': '/bin/bash', 08:15:21 INFO - 'SHLVL': '1', 08:15:21 INFO - 'TERM': 'linux', 08:15:21 INFO - 'TMOUT': '86400', 08:15:21 INFO - 'USER': 'cltbld', 08:15:21 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 08:15:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:15:21 INFO - '_': '/tools/buildbot/bin/python'} 08:15:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:15:22 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 08:15:22 INFO - Cleaning up... 08:15:22 INFO - Return code: 0 08:15:22 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:15:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:15:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:15:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b161f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c26a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e88630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f11850>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e866d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e86b60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:15:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 08:15:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 08:15:22 INFO - Using env: {'DISPLAY': ':0', 08:15:22 INFO - 'HOME': '/home/cltbld', 08:15:22 INFO - 'LANG': 'en_US.UTF-8', 08:15:22 INFO - 'LANGUAGE': 'en_US:en', 08:15:22 INFO - 'LOGNAME': 'cltbld', 08:15:22 INFO - 'MAIL': '/var/mail/cltbld', 08:15:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:15:22 INFO - 'MOZ_NO_REMOTE': '1', 08:15:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:15:22 INFO - 'NO_EM_RESTART': '1', 08:15:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:15:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:15:22 INFO - 'PWD': '/builds/slave/test', 08:15:22 INFO - 'SHELL': '/bin/bash', 08:15:22 INFO - 'SHLVL': '1', 08:15:22 INFO - 'TERM': 'linux', 08:15:22 INFO - 'TMOUT': '86400', 08:15:22 INFO - 'USER': 'cltbld', 08:15:22 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 08:15:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:15:22 INFO - '_': '/tools/buildbot/bin/python'} 08:15:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:15:22 INFO - Downloading/unpacking psutil>=3.1.1 08:15:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:15:24 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:15:24 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:15:24 INFO - Installing collected packages: psutil 08:15:24 INFO - Running setup.py install for psutil 08:15:24 INFO - building 'psutil._psutil_linux' extension 08:15:24 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 08:15:24 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 08:15:24 INFO - building 'psutil._psutil_posix' extension 08:15:24 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 08:15:24 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 08:15:24 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:15:24 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:15:25 INFO - Successfully installed psutil 08:15:25 INFO - Cleaning up... 08:15:25 INFO - Return code: 0 08:15:25 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:15:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:15:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:15:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b161f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c26a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e88630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f11850>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e866d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e86b60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:15:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 08:15:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 08:15:25 INFO - Using env: {'DISPLAY': ':0', 08:15:25 INFO - 'HOME': '/home/cltbld', 08:15:25 INFO - 'LANG': 'en_US.UTF-8', 08:15:25 INFO - 'LANGUAGE': 'en_US:en', 08:15:25 INFO - 'LOGNAME': 'cltbld', 08:15:25 INFO - 'MAIL': '/var/mail/cltbld', 08:15:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:15:25 INFO - 'MOZ_NO_REMOTE': '1', 08:15:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:15:25 INFO - 'NO_EM_RESTART': '1', 08:15:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:15:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:15:25 INFO - 'PWD': '/builds/slave/test', 08:15:25 INFO - 'SHELL': '/bin/bash', 08:15:25 INFO - 'SHLVL': '1', 08:15:25 INFO - 'TERM': 'linux', 08:15:25 INFO - 'TMOUT': '86400', 08:15:25 INFO - 'USER': 'cltbld', 08:15:25 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 08:15:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:15:25 INFO - '_': '/tools/buildbot/bin/python'} 08:15:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:15:25 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:15:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:27 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:15:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:15:27 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:15:27 INFO - Installing collected packages: mozsystemmonitor 08:15:27 INFO - Running setup.py install for mozsystemmonitor 08:15:27 INFO - Successfully installed mozsystemmonitor 08:15:27 INFO - Cleaning up... 08:15:27 INFO - Return code: 0 08:15:27 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:15:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:15:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:15:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:27 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b161f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c26a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e88630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f11850>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e866d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e86b60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:15:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 08:15:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 08:15:27 INFO - Using env: {'DISPLAY': ':0', 08:15:27 INFO - 'HOME': '/home/cltbld', 08:15:27 INFO - 'LANG': 'en_US.UTF-8', 08:15:27 INFO - 'LANGUAGE': 'en_US:en', 08:15:27 INFO - 'LOGNAME': 'cltbld', 08:15:27 INFO - 'MAIL': '/var/mail/cltbld', 08:15:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:15:27 INFO - 'MOZ_NO_REMOTE': '1', 08:15:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:15:27 INFO - 'NO_EM_RESTART': '1', 08:15:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:15:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:15:27 INFO - 'PWD': '/builds/slave/test', 08:15:27 INFO - 'SHELL': '/bin/bash', 08:15:27 INFO - 'SHLVL': '1', 08:15:27 INFO - 'TERM': 'linux', 08:15:27 INFO - 'TMOUT': '86400', 08:15:27 INFO - 'USER': 'cltbld', 08:15:27 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 08:15:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:15:27 INFO - '_': '/tools/buildbot/bin/python'} 08:15:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:15:27 INFO - Downloading/unpacking jsonschema==2.5.1 08:15:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:27 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:27 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:29 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:15:29 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:15:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:29 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:29 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:29 INFO - Downloading functools32-3.2.3-2.tar.gz 08:15:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:15:30 INFO - warning: no files found matching '*.txt' 08:15:30 INFO - no previously-included directories found matching 'build' 08:15:30 INFO - no previously-included directories found matching 'dist' 08:15:30 INFO - no previously-included directories found matching '.git*' 08:15:30 INFO - Installing collected packages: jsonschema, functools32 08:15:30 INFO - Running setup.py install for functools32 08:15:30 INFO - warning: no files found matching '*.txt' 08:15:30 INFO - no previously-included directories found matching 'build' 08:15:30 INFO - no previously-included directories found matching 'dist' 08:15:30 INFO - no previously-included directories found matching '.git*' 08:15:30 INFO - Successfully installed jsonschema functools32 08:15:30 INFO - Cleaning up... 08:15:30 INFO - Return code: 0 08:15:30 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:15:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:15:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:15:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:30 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b161f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c26a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e88630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f11850>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e866d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e86b60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:15:30 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 08:15:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 08:15:30 INFO - Using env: {'DISPLAY': ':0', 08:15:30 INFO - 'HOME': '/home/cltbld', 08:15:30 INFO - 'LANG': 'en_US.UTF-8', 08:15:30 INFO - 'LANGUAGE': 'en_US:en', 08:15:30 INFO - 'LOGNAME': 'cltbld', 08:15:30 INFO - 'MAIL': '/var/mail/cltbld', 08:15:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:15:30 INFO - 'MOZ_NO_REMOTE': '1', 08:15:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:15:30 INFO - 'NO_EM_RESTART': '1', 08:15:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:15:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:15:30 INFO - 'PWD': '/builds/slave/test', 08:15:30 INFO - 'SHELL': '/bin/bash', 08:15:30 INFO - 'SHLVL': '1', 08:15:30 INFO - 'TERM': 'linux', 08:15:30 INFO - 'TMOUT': '86400', 08:15:30 INFO - 'USER': 'cltbld', 08:15:30 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 08:15:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:15:30 INFO - '_': '/tools/buildbot/bin/python'} 08:15:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:15:30 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:15:30 INFO - Cleaning up... 08:15:30 INFO - Return code: 0 08:15:30 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:15:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:15:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:15:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:30 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b161f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c26a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e88630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f11850>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e866d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e86b60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:15:30 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 08:15:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 08:15:30 INFO - Using env: {'DISPLAY': ':0', 08:15:30 INFO - 'HOME': '/home/cltbld', 08:15:30 INFO - 'LANG': 'en_US.UTF-8', 08:15:30 INFO - 'LANGUAGE': 'en_US:en', 08:15:30 INFO - 'LOGNAME': 'cltbld', 08:15:30 INFO - 'MAIL': '/var/mail/cltbld', 08:15:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:15:30 INFO - 'MOZ_NO_REMOTE': '1', 08:15:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:15:30 INFO - 'NO_EM_RESTART': '1', 08:15:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:15:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:15:30 INFO - 'PWD': '/builds/slave/test', 08:15:30 INFO - 'SHELL': '/bin/bash', 08:15:30 INFO - 'SHLVL': '1', 08:15:30 INFO - 'TERM': 'linux', 08:15:30 INFO - 'TMOUT': '86400', 08:15:30 INFO - 'USER': 'cltbld', 08:15:30 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 08:15:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:15:30 INFO - '_': '/tools/buildbot/bin/python'} 08:15:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:15:30 INFO - Downloading/unpacking blobuploader==1.2.4 08:15:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:32 INFO - Downloading blobuploader-1.2.4.tar.gz 08:15:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:15:32 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:15:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:15:33 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:15:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:33 INFO - Downloading docopt-0.6.1.tar.gz 08:15:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:15:33 INFO - Installing collected packages: blobuploader, requests, docopt 08:15:33 INFO - Running setup.py install for blobuploader 08:15:33 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:15:33 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:15:33 INFO - Running setup.py install for requests 08:15:33 INFO - Running setup.py install for docopt 08:15:34 INFO - Successfully installed blobuploader requests docopt 08:15:34 INFO - Cleaning up... 08:15:34 INFO - Return code: 0 08:15:34 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:15:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:15:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:15:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:34 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b161f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c26a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e88630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f11850>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e866d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e86b60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:15:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 08:15:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:15:34 INFO - Using env: {'DISPLAY': ':0', 08:15:34 INFO - 'HOME': '/home/cltbld', 08:15:34 INFO - 'LANG': 'en_US.UTF-8', 08:15:34 INFO - 'LANGUAGE': 'en_US:en', 08:15:34 INFO - 'LOGNAME': 'cltbld', 08:15:34 INFO - 'MAIL': '/var/mail/cltbld', 08:15:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:15:34 INFO - 'MOZ_NO_REMOTE': '1', 08:15:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:15:34 INFO - 'NO_EM_RESTART': '1', 08:15:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:15:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:15:34 INFO - 'PWD': '/builds/slave/test', 08:15:34 INFO - 'SHELL': '/bin/bash', 08:15:34 INFO - 'SHLVL': '1', 08:15:34 INFO - 'TERM': 'linux', 08:15:34 INFO - 'TMOUT': '86400', 08:15:34 INFO - 'USER': 'cltbld', 08:15:34 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 08:15:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:15:34 INFO - '_': '/tools/buildbot/bin/python'} 08:15:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:15:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:15:34 INFO - Running setup.py (path:/tmp/pip-anx3ju-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:15:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:15:34 INFO - Running setup.py (path:/tmp/pip-ol868o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:15:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:15:34 INFO - Running setup.py (path:/tmp/pip-7Zh9H7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:15:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:15:34 INFO - Running setup.py (path:/tmp/pip-gPiJlg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:15:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:15:34 INFO - Running setup.py (path:/tmp/pip-uLpQBZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:15:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:15:34 INFO - Running setup.py (path:/tmp/pip-gQUPKc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:15:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:15:34 INFO - Running setup.py (path:/tmp/pip-9_qxto-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:15:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:15:34 INFO - Running setup.py (path:/tmp/pip-jW0SmS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:15:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:15:34 INFO - Running setup.py (path:/tmp/pip-c54uNd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:15:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:15:34 INFO - Running setup.py (path:/tmp/pip-x1xA_t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:15:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:15:35 INFO - Running setup.py (path:/tmp/pip-sX8B8g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:15:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:15:35 INFO - Running setup.py (path:/tmp/pip-Hd8ljo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:15:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:15:35 INFO - Running setup.py (path:/tmp/pip-sdxmCb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:15:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:15:35 INFO - Running setup.py (path:/tmp/pip-U7HTov-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:15:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:15:35 INFO - Running setup.py (path:/tmp/pip-HFxRrv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:15:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:15:35 INFO - Running setup.py (path:/tmp/pip-_PcscG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:15:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:15:35 INFO - Running setup.py (path:/tmp/pip-ZWPZqy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:15:35 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:15:35 INFO - Running setup.py install for manifestparser 08:15:35 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:15:35 INFO - Running setup.py install for mozcrash 08:15:35 INFO - Running setup.py install for mozdebug 08:15:35 INFO - Running setup.py install for mozdevice 08:15:35 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:15:35 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:15:35 INFO - Running setup.py install for mozfile 08:15:36 INFO - Running setup.py install for mozhttpd 08:15:36 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:15:36 INFO - Running setup.py install for mozinfo 08:15:36 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:15:36 INFO - Running setup.py install for mozInstall 08:15:36 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:15:36 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:15:36 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:15:36 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:15:36 INFO - Running setup.py install for mozleak 08:15:36 INFO - Running setup.py install for mozlog 08:15:36 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:15:36 INFO - Running setup.py install for moznetwork 08:15:36 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:15:36 INFO - Running setup.py install for mozprocess 08:15:36 INFO - Running setup.py install for mozprofile 08:15:36 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:15:36 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:15:36 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:15:36 INFO - Running setup.py install for mozrunner 08:15:37 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:15:37 INFO - Running setup.py install for mozscreenshot 08:15:37 INFO - Running setup.py install for moztest 08:15:37 INFO - Running setup.py install for mozversion 08:15:37 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:15:37 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:15:37 INFO - Cleaning up... 08:15:37 INFO - Return code: 0 08:15:37 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:15:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:15:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:15:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b161f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c26a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e88630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f11850>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e866d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e86b60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:15:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 08:15:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:15:37 INFO - Using env: {'DISPLAY': ':0', 08:15:37 INFO - 'HOME': '/home/cltbld', 08:15:37 INFO - 'LANG': 'en_US.UTF-8', 08:15:37 INFO - 'LANGUAGE': 'en_US:en', 08:15:37 INFO - 'LOGNAME': 'cltbld', 08:15:37 INFO - 'MAIL': '/var/mail/cltbld', 08:15:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:15:37 INFO - 'MOZ_NO_REMOTE': '1', 08:15:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:15:37 INFO - 'NO_EM_RESTART': '1', 08:15:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:15:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:15:37 INFO - 'PWD': '/builds/slave/test', 08:15:37 INFO - 'SHELL': '/bin/bash', 08:15:37 INFO - 'SHLVL': '1', 08:15:37 INFO - 'TERM': 'linux', 08:15:37 INFO - 'TMOUT': '86400', 08:15:37 INFO - 'USER': 'cltbld', 08:15:37 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 08:15:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:15:37 INFO - '_': '/tools/buildbot/bin/python'} 08:15:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:15:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:15:37 INFO - Running setup.py (path:/tmp/pip-LM_0Jf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:15:37 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 08:15:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:15:37 INFO - Running setup.py (path:/tmp/pip-8iY775-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:15:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:15:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:15:37 INFO - Running setup.py (path:/tmp/pip-yopjcS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:15:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:15:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:15:37 INFO - Running setup.py (path:/tmp/pip-o4ns7t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:15:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:15:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:15:37 INFO - Running setup.py (path:/tmp/pip-LcEPIm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:15:37 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 08:15:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:15:37 INFO - Running setup.py (path:/tmp/pip-nIYfqv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 08:15:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:15:38 INFO - Running setup.py (path:/tmp/pip-U9D2si-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 08:15:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:15:38 INFO - Running setup.py (path:/tmp/pip-6Oqm73-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 08:15:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:15:38 INFO - Running setup.py (path:/tmp/pip-IJP98c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 08:15:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:15:38 INFO - Running setup.py (path:/tmp/pip-R53172-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:15:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:15:38 INFO - Running setup.py (path:/tmp/pip-RIbLyL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 08:15:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:15:38 INFO - Running setup.py (path:/tmp/pip-QgdtR6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.24 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 08:15:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:15:38 INFO - Running setup.py (path:/tmp/pip-QsvwHo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 08:15:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:15:38 INFO - Running setup.py (path:/tmp/pip-fkKf1o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 08:15:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:15:38 INFO - Running setup.py (path:/tmp/pip-dMEhOX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 08:15:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:15:38 INFO - Running setup.py (path:/tmp/pip-7fo4PD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 08:15:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:15:38 INFO - Running setup.py (path:/tmp/pip-Alxf3x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:15:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:15:38 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:15:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:15:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:15:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:15:40 INFO - Downloading blessings-1.6.tar.gz 08:15:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:15:40 INFO - Installing collected packages: blessings 08:15:40 INFO - Running setup.py install for blessings 08:15:41 INFO - Successfully installed blessings 08:15:41 INFO - Cleaning up... 08:15:41 INFO - Return code: 0 08:15:41 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:15:41 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:15:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:15:41 INFO - Reading from file tmpfile_stdout 08:15:41 INFO - Current package versions: 08:15:41 INFO - argparse == 1.2.1 08:15:41 INFO - blessings == 1.6 08:15:41 INFO - blobuploader == 1.2.4 08:15:41 INFO - docopt == 0.6.1 08:15:41 INFO - functools32 == 3.2.3-2 08:15:41 INFO - jsonschema == 2.5.1 08:15:41 INFO - manifestparser == 1.1 08:15:41 INFO - mozInstall == 1.12 08:15:41 INFO - mozcrash == 1.0 08:15:41 INFO - mozdebug == 0.1 08:15:41 INFO - mozdevice == 0.49 08:15:41 INFO - mozfile == 1.2 08:15:41 INFO - mozhttpd == 0.7 08:15:41 INFO - mozinfo == 0.9 08:15:41 INFO - mozleak == 0.1 08:15:41 INFO - mozlog == 3.4 08:15:41 INFO - moznetwork == 0.27 08:15:41 INFO - mozprocess == 0.24 08:15:41 INFO - mozprofile == 0.28 08:15:41 INFO - mozrunner == 6.13 08:15:41 INFO - mozscreenshot == 0.1 08:15:41 INFO - mozsystemmonitor == 0.3 08:15:41 INFO - moztest == 0.8 08:15:41 INFO - mozversion == 1.4 08:15:41 INFO - psutil == 3.1.1 08:15:41 INFO - requests == 1.2.3 08:15:41 INFO - wsgiref == 0.1.2 08:15:41 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:15:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:15:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:15:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:41 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b161f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c26a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e88630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f11850>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e866d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e86b60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:15:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 08:15:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:15:41 INFO - Using env: {'DISPLAY': ':0', 08:15:41 INFO - 'HOME': '/home/cltbld', 08:15:41 INFO - 'LANG': 'en_US.UTF-8', 08:15:41 INFO - 'LANGUAGE': 'en_US:en', 08:15:41 INFO - 'LOGNAME': 'cltbld', 08:15:41 INFO - 'MAIL': '/var/mail/cltbld', 08:15:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:15:41 INFO - 'MOZ_NO_REMOTE': '1', 08:15:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:15:41 INFO - 'NO_EM_RESTART': '1', 08:15:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:15:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:15:41 INFO - 'PWD': '/builds/slave/test', 08:15:41 INFO - 'SHELL': '/bin/bash', 08:15:41 INFO - 'SHLVL': '1', 08:15:41 INFO - 'TERM': 'linux', 08:15:41 INFO - 'TMOUT': '86400', 08:15:41 INFO - 'USER': 'cltbld', 08:15:41 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 08:15:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:15:41 INFO - '_': '/tools/buildbot/bin/python'} 08:15:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 08:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 08:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 08:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 08:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 08:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 08:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 08:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:15:41 INFO - Cleaning up... 08:15:41 INFO - Return code: 0 08:15:41 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:15:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:15:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:15:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:15:41 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1b161f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c26a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e88630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f11850>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e866d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e86b60>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:15:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 08:15:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 08:15:41 INFO - Using env: {'DISPLAY': ':0', 08:15:41 INFO - 'HOME': '/home/cltbld', 08:15:41 INFO - 'LANG': 'en_US.UTF-8', 08:15:41 INFO - 'LANGUAGE': 'en_US:en', 08:15:41 INFO - 'LOGNAME': 'cltbld', 08:15:41 INFO - 'MAIL': '/var/mail/cltbld', 08:15:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:15:41 INFO - 'MOZ_NO_REMOTE': '1', 08:15:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:15:41 INFO - 'NO_EM_RESTART': '1', 08:15:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:15:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:15:41 INFO - 'PWD': '/builds/slave/test', 08:15:41 INFO - 'SHELL': '/bin/bash', 08:15:41 INFO - 'SHLVL': '1', 08:15:41 INFO - 'TERM': 'linux', 08:15:41 INFO - 'TMOUT': '86400', 08:15:41 INFO - 'USER': 'cltbld', 08:15:41 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 08:15:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:15:41 INFO - '_': '/tools/buildbot/bin/python'} 08:15:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:15:41 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:15:41 INFO - Cleaning up... 08:15:41 INFO - Return code: 0 08:15:41 INFO - Running post-action listener: _resource_record_post_action 08:15:41 INFO - Running post-action listener: _start_resource_monitoring 08:15:41 INFO - Starting resource monitoring. 08:15:41 INFO - [mozharness: 2017-02-26 16:15:41.798242Z] Finished create-virtualenv step (success) 08:15:41 INFO - [mozharness: 2017-02-26 16:15:41.798689Z] Running install step. 08:15:41 INFO - Running pre-action listener: _resource_record_pre_action 08:15:41 INFO - Running main action method: install 08:15:41 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:15:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:15:42 INFO - Reading from file tmpfile_stdout 08:15:42 INFO - Detecting whether we're running mozinstall >=1.0... 08:15:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:15:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:15:42 INFO - Reading from file tmpfile_stdout 08:15:42 INFO - Output received: 08:15:42 INFO - Usage: mozinstall [options] installer 08:15:42 INFO - Options: 08:15:42 INFO - -h, --help show this help message and exit 08:15:42 INFO - -d DEST, --destination=DEST 08:15:42 INFO - Directory to install application into. [default: 08:15:42 INFO - "/builds/slave/test"] 08:15:42 INFO - --app=APP Application being installed. [default: firefox] 08:15:42 INFO - mkdir: /builds/slave/test/build/application 08:15:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 08:15:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 08:15:59 INFO - Reading from file tmpfile_stdout 08:15:59 INFO - Output received: 08:15:59 INFO - /builds/slave/test/build/application/firefox/firefox 08:15:59 INFO - Running post-action listener: _resource_record_post_action 08:15:59 INFO - [mozharness: 2017-02-26 16:15:59.459018Z] Finished install step (success) 08:15:59 INFO - [mozharness: 2017-02-26 16:15:59.459290Z] Running run-tests step. 08:15:59 INFO - Running pre-action listener: _resource_record_pre_action 08:15:59 INFO - Running main action method: run_tests 08:15:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:15:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:15:59 INFO - Python 2.7.3 08:15:59 INFO - Return code: 0 08:15:59 INFO - grabbing minidump binary from tooltool 08:15:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 08:15:59 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f11850>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e866d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e86b60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:15:59 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 08:15:59 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 08:15:59 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 08:15:59 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:15:59 INFO - Return code: 0 08:15:59 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:15:59 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:15:59 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:15:59 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:15:59 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:15:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-024', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 08:15:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-024 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 08:15:59 INFO - Using env: {'DISPLAY': ':0', 08:15:59 INFO - 'HOME': '/home/cltbld', 08:15:59 INFO - 'LANG': 'en_US.UTF-8', 08:15:59 INFO - 'LANGUAGE': 'en_US:en', 08:15:59 INFO - 'LOGNAME': 'cltbld', 08:15:59 INFO - 'MAIL': '/var/mail/cltbld', 08:15:59 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:15:59 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:15:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:15:59 INFO - 'MOZ_NO_REMOTE': '1', 08:15:59 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:15:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:15:59 INFO - 'NO_EM_RESTART': '1', 08:15:59 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:15:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:15:59 INFO - 'PWD': '/builds/slave/test', 08:15:59 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:15:59 INFO - 'SHELL': '/bin/bash', 08:15:59 INFO - 'SHLVL': '1', 08:15:59 INFO - 'TERM': 'linux', 08:15:59 INFO - 'TMOUT': '86400', 08:15:59 INFO - 'USER': 'cltbld', 08:15:59 INFO - 'XDG_SESSION_COOKIE': '41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717', 08:15:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:15:59 INFO - '_': '/tools/buildbot/bin/python'} 08:15:59 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-024', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 08:15:59 INFO - mozversion application_buildid: 20170226151905 08:15:59 INFO - mozversion application_changeset: 4d497454ce0c0e1c6f3339c1e1a17528e894d7ce 08:15:59 INFO - mozversion application_display_name: FirefoxDeveloperEdition 08:15:59 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:15:59 INFO - mozversion application_name: Firefox 08:15:59 INFO - mozversion application_remotingname: firefox-dev 08:15:59 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:15:59 INFO - mozversion application_vendor: Mozilla 08:15:59 INFO - mozversion application_version: 53.0a2 08:15:59 INFO - mozversion platform_buildid: 20170226151905 08:15:59 INFO - mozversion platform_changeset: 4d497454ce0c0e1c6f3339c1e1a17528e894d7ce 08:15:59 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:15:59 INFO - mozversion platform_version: 53.0a2 08:15:59 INFO - using testdate: 1488125759 08:15:59 INFO - actual date: 1488125759 08:15:59 INFO - starting webserver on 'localhost:55905' 08:15:59 INFO - SUITE-START | Running 2 tests 08:15:59 INFO - TEST-START | dromaeo_css 08:15:59 INFO - operating with platform_type : linux_ 08:15:59 INFO - Initialising browser for dromaeo_css test... 08:15:59 INFO - TEST-INFO | started process 4724 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpyZbZHO/profile http://localhost:55905/getInfo.html) 08:16:03 INFO - PROCESS | 4724 | __metrics Screen width/height:1600/1200 08:16:03 INFO - PROCESS | 4724 | colorDepth:24 08:16:03 INFO - PROCESS | 4724 | Browser inner width/height: 1024/697 08:16:03 INFO - PROCESS | 4724 | __metrics 08:16:04 INFO - PROCESS | 4724 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:16:04 INFO - PROCESS | 4724 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:16:05 INFO - TEST-INFO | 4724: exit 0 08:16:05 INFO - Browser initialized. 08:16:05 INFO - Running cycle 1/1 for dromaeo_css test... 08:16:05 INFO - TEST-INFO | started process 4817 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpyZbZHO/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:16:17 INFO - PROCESS | 4817 | RSS: Main: 138158080 08:16:17 INFO - PROCESS | 4817 | 08:19:18 INFO - PROCESS | 4817 | Cycle 1(1): loaded http://localhost:55905/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55905/tests/dromaeo/cssquery-ext.html) 08:19:19 INFO - PROCESS | 4817 | RSS: Main: 244297728 08:19:19 INFO - PROCESS | 4817 | 08:21:07 INFO - PROCESS | 4817 | ************************* 08:21:07 INFO - PROCESS | 4817 | A coding exception was thrown and uncaught in a Task. 08:21:07 INFO - PROCESS | 4817 | 08:21:07 ERROR - PROCESS | 4817 | Full message: TypeError: NetworkError when attempting to fetch resource. 08:21:07 INFO - PROCESS | 4817 | Full stack: 08:21:07 INFO - PROCESS | 4817 | ************************* 08:22:22 INFO - PROCESS | 4817 | Cycle 1(1): loaded http://localhost:55905/tests/dromaeo/cssquery-ext.html (next: http://localhost:55905/tests/dromaeo/cssquery-jquery.html) 08:22:22 INFO - PROCESS | 4817 | RSS: Main: 225042432 08:22:22 INFO - PROCESS | 4817 | 08:25:24 INFO - PROCESS | 4817 | Cycle 1(1): loaded http://localhost:55905/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55905/tests/dromaeo/cssquery-mootools.html) 08:25:25 INFO - PROCESS | 4817 | RSS: Main: 199970816 08:25:25 INFO - PROCESS | 4817 | 08:28:26 INFO - PROCESS | 4817 | Cycle 1(1): loaded http://localhost:55905/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55905/tests/dromaeo/cssquery-prototype.html) 08:28:27 INFO - PROCESS | 4817 | RSS: Main: 172625920 08:28:27 INFO - PROCESS | 4817 | 08:31:30 INFO - PROCESS | 4817 | Cycle 1(1): loaded http://localhost:55905/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55905/tests/dromaeo/cssquery-yui.html) 08:31:30 INFO - PROCESS | 4817 | RSS: Main: 174157824 08:31:30 INFO - PROCESS | 4817 | 08:34:33 INFO - PROCESS | 4817 | Cycle 1(1): loaded http://localhost:55905/tests/dromaeo/cssquery-yui.html (next: http://localhost:55905/tests/dromaeo/cssquery-dojo.html) 08:34:33 INFO - PROCESS | 4817 | RSS: Main: 263946240 08:34:33 INFO - PROCESS | 4817 | 08:34:33 INFO - PROCESS | 4817 | __start_tp_report 08:34:33 INFO - PROCESS | 4817 | _x_x_mozilla_page_load 08:34:33 INFO - PROCESS | 4817 | _x_x_mozilla_page_load_details 08:34:33 INFO - PROCESS | 4817 | |i|pagename|runs| 08:34:33 INFO - PROCESS | 4817 | |0;dojo.html;3313.834308284586;3344.48160535117;3355.4463513520272;3373.0218236711353;3390.4744764561488;5432.402435732071;5512.72436378181;5521.199426083221;5523.502884740373;5553.805616803413;5513.228148059265;5567.972160139194;5574.721263936797;5584.692841893694;5617.4382561743805;5048.621353398501;5068.72122033288;5105.05556472052;5147.974260128694;5166.870828229286;4931.556159945604;5105.106606343894;5156.819511317105;5161.225816127573;5161.612879034069;4916.778744956486;4955.306257124005;4973.154563724175;5003.899922001558;5084.872878178038;5060.671056381323;5101.362329708786;5102.260172275;5104.948950510485;5133.794648214067;4848.2727590861305;5011.398632164163;5014.197728363481;5078.26365177051;5089.982003599295;5387;5391.299131112969;5474.206240095164;5500.559955203614;5570.610057295991;5926.585139040269;5930.080837470199;5934.317553481362;5934.673592952386;5937.762489500415;5942.673152976585;5952.613080149819;5964.612300200516;5971.104334349839;5976.193213916109;5412.621116521845;5451.100568406208;5461.808836690737;5501.174823776386;5573.303337082864;6016.458518733335;6020.277566692025;6020.578559500793;6041.184440100618;6043.667598282137;5775.364709881909;5830.7959221427045;5841.7371218295275;5844.853878653068;5848.88302233953;5748.39641837601;5784.421557844266;5790.652560846363;5849.444302791228;5906.822795316061;5841.649501029951;5881.470667639933;5881.9705901470215;5909.5863289569315;5926.081457374114;5837.357890632027;5839.211706419579;5841.386654401312;5842.707864606753;5849.53203743708;4483.865484035484;4504.932426013613;4546.840860569864;4551.886202844956;4553.590176884097;4014.5383280922483;4053.635172834459;4076.6331030207425;4081.10215752534;4085.754854708727;5677.914831277534;5678.14827775837;5680.091185410314;5680.289963754531;5717.028105222123;5655.7454914528125;5748.02283611787;5856.1508581255475;5905.763769449174;5908.468237858613;5745.9425405745405;5748.31020277561;5752;5757.107648314518;5778.046622307273;5062.316587260672;5069.163588008011;5077.492250774893;5078.492150784966;5078.568321692624;6021.668808215591;6063.757449701962;6098.11577321277;6168.722407491674;6181.103739957771;5919.289685237799;5982.700864956648;5988.131720900532;6003.6998150093195;6025.186599809145;6186.721597528212;6193.504519638508;6194.81415557534;6196.318404975539;6197.194364732556;5671.914921276101;5688.516476099578;5827.271591051119;5886.793962211302;5888;5866.67733274674;5882.058870580858;5904.734286957011;5923.911141332969;6000.189974353407;5805.651660900359;5808.883822323614;5811.041178205549;5814.098814683731;5814.825555233349;5655.208270842168;5817.127430885401;5820.388859169726;5823.7379317931645;5824.068149096124;5588.30146231721;5627.099664053731;5659.094544872801;5663.57523185771;5752.856178595569;5754.4533269339345;5763.625364351471;5770.480656740746;5772;5772.278465191851;5629.437056294338;5633.3521645009705;5642.60501764889;5646.322441306905;5648.689322087324 08:34:33 INFO - PROCESS | 4817 | |1;ext.html;560.3813350666745;586.8796896636188;604.9685286586373;611.1321922869524;642.2549842183063;39304.41043384348;40133;40181.79909100454;40259.39610905832;47525.52474475254;51368.74315628426;52013;52098.218526722034;52268;52454;9184.127507886757;9413.81172376552;9419.199368053723;9423.199028082621;9442.622295108187;8805.779855503599;8989.550522473883;9334.346595738301;9459.337846350758;10896.509657065451;11000.944995275053;11391.943040284787;11409.828852567218;11410.144239182053;11413.657590272263;11273.605423810168;11322.830157547643;11375.146863985234;11387.202895797298;11387.715307117305;11277.661670149908;11337.829932551018;11348.375839328834;11355.034822040136;11355.205135640508;48771.26843097356;48905;48956.75521622369;49095.509044909806;49158.754206229096;4419.690621656486;4424.358468022118;4462.419885414908;4570.634349252052;4594.310853372021;31528.211794705087;31787.523187152212;34312.48531272033;35266.82366588151;36903.81548092242;4532.116237333721;4583.220852455091;4591.104734576759;4618.607418369443;4664.463586687541;365407;366226;368229;369664;371260.9999999973;71044;71295.64352178205;71435.64282178556;71509.2849071513;71535.64232178805;73120.26879731241;73241;73262.63368683122;73906.26093739101;73917.6304118476;19592.11835467379;20166.899165504372;20196.29312974039;20200.29298974529;20227.797722022886;14563.854361456462;14595.854041459663;14600.196989165697;14606.63483412902;14608.48870289556;18567.721484177477;18978.24087036503;19669.50826229356;20268.898655506924;20423.387298381072;6638.701258443381;6640.933590664032;6700.899486507707;6749.426298764562;6873.872388063419;971.9757006074905;979.8873129590188;985.2708995343394;1000.73407139968;1011.5549158370294;33248;33303.50044749331;33384;33658.49512257318;34151.14622134417;1059.86751656043;1133.2294040052843;1135.920485566019;1139.2424038014628;1172.9648110556698;17028.233729482203;18374.63250734978;18377.17302721381;18429.26282948667;18484.81515184831;477917.2208277942;478243;478884;481838;484169;68853.65573172102;68939.31060689429;68999.65500172468;69085;69177.65411172912;1496.8428315026765;1503.6466430389069;1536.7464368379315;1539.4304107480305;1551.3794482207206;31045.68954310518;32735.67264327326;32786;32790;33159.17102072371;58686.4131358698;59059;59218.40781592301;59429;59468;393029;394087;396022;396784;397737;40345;41594;45663.54336456593;45773.08453830971;46454.53545464502;58623;59602.70198648979;59689;59839.70080149572;60194.39805602063;43905.34141987937;46219.768901156625;46586.301205482625;46978.76510617562;47383.52616473791;38368;42313.365299521145;43436.78281608572;45766;47691.76154119346;40437.79781101076;40835.59164408318;41595.37606935959;42021.36967945422;42323.7883810579;33430;35930.8203458981;36309.45535816912;36611.26777464383;37058.44412333871;26837.597436038865;26937.326566835985;27161.45677086487;27163.320916977234;27249.591256130778 08:34:33 INFO - PROCESS | 4817 | |2;jquery.html;431.5641202385593;442.4403130040499;445.55889669227463;445.64571165923087;457.3026135143905;19698.21207151714;20387.796122038777;21286.57426851462;21357.893210533926;21437.14251429943;21903.780962190413;22991.42521436965;23092.191773287937;23099.538009239805;23251.651225231635;5945.821625351246;6018.759249630009;6203.565750397474;6208.472279856195;6209.068639704035;5946.108083787445;6122.234720659918;6126.23422072241;6129.816105516819;6131.3562075982045;5896.7051647417675;6055.515558755311;6078.5441091918065;6101.145839582462;6105.938940610604;6060.181875446824;6112.938870611326;6113.602615829956;6120;6121.3572574879445;5381.811636592701;5470.316210473691;5484.972575137099;5501.394846566875;5523.199136125279;24323;24454.14410495624;26081;26884.73115268842;27187.728122718916;2550.7831834294107;2642.101685426964;2642.524345617788;2672.5055864664905;2702.2568793581727;11240.49417776202;11432.71418214543;11777.646670599896;11879.524819007229;14033.929830350886;1957.168203513501;2005.2780998840406;2015.083137172583;2027.1789925080366;2054.445299769054;104168;104213.4789326056;104393;104663.47668261686;106837;12511.937440312922;12518.687032824253;12591.24452532851;12696.87303126957;12923.095383323265;18177.272909083753;18187.63624727498;18188.272469101354;18222.726659100124;18231;9346.48594327305;9488.335816492918;9555.754397716531;9602.9039709602;9657.806843863083;9130.680426185052;9134.492808686626;9141.588628511732;9168.633254669738;9374.156325930699;5498.340199176045;5507.752151153128;5531.889362212733;5548.361938377057;5589.5807814413265;2170.7192756273557;2230.408941630469;2259.209276753123;2264.5584111098506;2279.316205138452;921.235374639048;922.3866129024124;933.803901180746;947.1002547579827;953.68051702679;19411.805881941284;19769.11039003248;20544.28095016667;20881.68677469839;21112.894435528033;943.5329511891657;945.8061097475002;955.5317894231777;962.8844538655406;979.0894468144694;10812.080973117216;11243.325400475998;11320.37737924422;11325.433728313552;11466.2546934449;691787;701896;711903;714392;720659;85239.57380213184;85437;109697.45151274193;109984;112366;1138.2373809547623;1163.668354518958;1164.2083383299268;1167.480471190312;1180.913559525239;19312.90343548273;19679.31122410709;19705.408837734893;19743.308984185485;19747.703784442958;38865;43980.78009609931;44059.55940440555;44116;44541.999999998705;58466;62242.2654640723;63401;63409.36590634035;64643.03035454566;9588.66439674608;9689.70930872075;9716.659916902874;9850.408975461496;9870.161036311994;14824.332905019515;14839.183844888636;15008.849911500745;15291.923540382228;15485.303161357991;6383.39357761012;12373.690657733629;12676.619701408972;12762.744745104861;12766.425510851848;12058.336791476553;12137.939310303746;12439.937800310941;12553.372331383212;12973.870261297267;12486.750264994467;12583.370831458573;12704.936475317565;12746.68133296675;12878.227306361649;9479.146876781122;9683.854742179014;9685.467299298607;9812.55843487059;10141.442220677933;12538.435770390537;12569.245845249314;12578.685532861751;12593.874061259638;12771.361431928552 08:34:33 INFO - PROCESS | 4817 | |3;mootools.html;1343.5431953135933;1472.860078292562;1479.8076250087488;1502.6919481506288;1503.7593984962402;7593.240675932404;7793.53238805672;8080.636371363295;8081.070676872161;8327;8126.553039582821;8201.58992050398;8203.753887383373;8205.507669539817;8207.138250483702;2075.6471399861985;2147.44166516706;2149.967750483744;2381.1665916929064;2417.226487523993;2158.384860314811;2387.606045002581;2460.6063029915217;2465.100238412975;2473.6413220083077;2362.586547354215;2381.4641705616273;2382.0590866607768;2382.880855957204;2384.2489615771065;2280.4754906371545;2314.2941402872116;2316.281952594701;2317.5249073939804;2317.918872839451;2348.976510234893;2351.1535847095033;2417.395651087228;2421.624648179535;2425.2360506440414;8381.203785640355;8417.494950303002;8429.283510901581;8432;8438.746837594881;5261.342332208474;5397.649152805055;5406.053940560386;5406.243125962368;5408.080626293539;3131.2954585218145;3276.3774882772195;3382.475716263983;3395.2530443302435;3397.3884700753856;1269.904757143218;1337.5184933424057;1373.3270697358323;1391.6660001599544;1450.1226757811478;11511.194216404854;11575.13186511015;11601.651950441415;11602.303861768236;11626.476808543635;4525.728456292567;4761.35721677576;4833.806647734122;4834.226523756182;4842.927356089662;9967.10296073357;9971.152452041513;9984.301098923152;9986.051325124101;9997.300188986846;5441.700706461183;5459.099248623933;5459.672419654754;5459.808906688327;5465;4388.1223755249075;4887;4928.285398617252;4983.6760610560195;4998.150314446553;3795.753276037104;4025.9597404025585;4139.337705967031;4193.580641935843;4194.895127621834;1310.2531557012412;1311.302914943984;1323.6823162441137;1327.6548097494529;1329.2091205732575;934.3039435620507;983.9852402213972;991.9057689519484;1000.034966257565;1015.4668798880499;5684.54523638108;5903.321118071477;5986.850328741816;6016.428439298347;6272.40412160844;1021.8262895307815;1073.9570417183381;1082.821334479802;1085.647164671485;1107.1917500224881;3961.485006949136;3997.2605068062503;4025.2352053109817;4035.4350390944705;4048.959510404917;10160.33957792741;10452.216083793746;10473.423961682181;10476.214283928735;10477;10413.479326033668;10420.06219440254;10541.894581054245;10547.525361358757;10560.102391296672;7589.279018493235;8002.319802816709;8003.119656837744;8028.839423211503;8129.918700813035;5714.5999780015;5839.328477225004;5944.613600115978;5954.225950626565;5981.102834574848;9193.954030229806;9244.722658320261;9259.074092590687;9380.48407337603;9454;9019.864702029343;9176.44941303524;9285.117913798178;9453.810923781624;9454.196393306645;7534.773956781305;7631.465797394351;7647.579383133981;7704.537727736129;7731.574763388067;8132.064812546396;8191.590420478833;8208.302294305051;8211.548364839753;8214.671413143646;7304.817379565553;7322.670479828314;7352.558846469229;7406.296401841816;7553.32020118192;7045.11936007999;7077.363037326665;7120.964395178198;7136.785896423115;7186.425085993213;6553.082568440517;6574.8356291091195;6597.637129957899;6599.8020059398295;6600;5085.160948443613;5086;5164.664296820694;5259.053370393366;5290.629655924048;5033.597312215087;5043.697378157322;5114.258432527188;5152.948470515397;5221.503957124067 08:34:33 INFO - PROCESS | 4817 | |4;prototype.html;401.7167896632874;402.9717919745617;408.7179845906323;413.5389041219042;419.4756554307116;5411.594130440218;5468.425815289397;5468.863278418036;5477.726113694319;5479.232907392959;5265.526102650761;5342.332208473941;5382;5386.165144402614;5453.15476101204;4306.676999225055;4362.847300344489;4378.32136018916;4380.540043295456;4389.648828093761;4380.759058251795;4381.38660587518;4383.956160438387;4393.802278897458;4394.428724265841;4280.608802139302;4315.834724624349;4336.609705126538;4345.348197770344;4350.58669426404;4308.405889820755;4334.50153232376;4335.544767799367;4336.371226172203;4342.4789025317;3958.762474251554;3972.066564357374;3982.14830104003;3997.160596274786;4014.136960553495;5133.974330128362;5245.186996015624;5274.2879711238875;5276.994741998016;5340.385855626614;4997.325361076245;4998.425181104183;4999.725015124167;5014.924776128361;5046.7476626168545;5710.514606258473;5713.800016999385;5715.599908006441;5753.1370294456165;5759.625624334405;4288.76411797351;4319.33050377192;4332.891677708051;4378.117409513908;4415.403920470728;5616.943830561683;5773.88452230953;5826;5846.766129354821;5881.382454842223;4374.868753937387;4461.375407442961;4461.620762235247;4463.352813841975;4477.238869392211;4278.251306021434;4525.456945166536;4527.320901864747;4532.297493888453;4554.362389265505;4848.95151048485;4881.8535443936735;4934.4572097069295;4970.353853998957;4998.375527953357;5623.790884959753;5643.858903527363;5649.661020338793;5681.687507187145;5703.344115426779;1467.4277031957545;1514.4093803416677;1526.8167170442773;1528.778327142558;1543.884208684353;1067.7597540553468;1085.87069447775;1095.687728997232;1100.2573263047411;1116.8883111688765;5344.9732751336;5355.491228333302;5359.785608575691;5370.3287089113865;5378.623496355218;5604.523615492647;5610.803621873297;5625.353084395347;5678.744456499468;5689.77240910359;5236.345456817898;5396.2984811974975;5421.749973760924;5430.42980487051;5546.805861794898;2974.9256268593026;2983.4928062229474;2985.6118704568266;2987.656419511784;2997.190758495194;5793.275840519935;5804.390538993429;5835.912461313083;5847.766089356463;5864.824055278348;5497.972510137423;5722.971385143048;5724.341700704473;5732.742026608813;5763.6541807491685;5832.7168023034865;5838.321857230003;5842.005085651792;5844.311616656386;5888.852778680567;5351.411344752152;5562.249096371938;5587.804426845041;5642.633228840113;5685.943140568541;5547.446714919829;5572.91640625399;5578.82844602638;5578.86052848682;5579.652208674763;5752.597318187687;5817.505512031525;5870.383609721089;5979.521638268841;6009.128676341993;4187;4199.4330765346285;4214.683898707548;4230.70385073042;4256.34026725858;5747.971260143672;5817.76728930838;5831.7375718091935;5836.970815145897;5857.0043092673495;5617.7191140442;5618.876224755147;5625;5627.831165065055;5636.661800291996;5629.127485239795;5635.9436405635415;5637.746301416364;5664.660120392789;5677.9495793278375;5407.621466497465;5573.359063707726;5622.297212848394;5622.690752008679;5628.8874222514505;5604.915926261027;5613.326400831927;5623.381428042994;5654.46282603152;5660.518855897295;5356.303680521663;5514.207882438304;5526.171074338881;5564.805231817029;5610.6154884174875 08:34:33 INFO - PROCESS | 4817 | |5;yui.html;769.4572382373341;787.6298139874257;800.1558355934487;867.4925168776266;920.4385324951776;15404.61488462789;15929.362825486982;16115.355385784569;16332.18339083044;16644.251008704607;14799;14999.85000149998;15024.624384390396;15214.239288035582;15363.769543456858;705.1608585782927;825.7440193540007;835.0063424524826;835.6657337065162;836.5566249887539;730.82825535999;794.3327604811957;828.8218033122878;831.7504748575434;833.3166803221361;861.0528418739399;861.9698310559131;862.762740246431;862.8490014247513;863.2403484933282;717.3687155303352;854.1159899504015;856.6016802187013;857.3355649371724;857.7812657772259;556.9275994120779;604.4076804731388;630.6941133550224;634.311771727676;636.0332294911708;15843.603909902346;15848.207589620588;15899.44351947688;15916.522504324888;15942;13256.204627722367;13573.524926627619;13774.793378099237;13822.170669759847;15084.321205545777;13703.45186192551;13799.793003104962;14287.428502859977;14343.85656143446;14650.095487586652;4707.5763181313505;4742.407199100113;4765.166095933232;4908;4949.678270912415;84575.577122114;84739.15260847374;85585.14414855833;87747.56126219392;87967.56016219941;12344.567940122053;12549.996000320136;12563.93718031404;12576.119671622899;12587.37063146839;23649.172278970153;23688.881555592456;23825.166119185746;24048.51902961931;24450.14424495134;8440.704575339834;8512.404131710844;8560.186782255676;8564.357673174536;8703.738887833375;4597.770111494412;4605.332226827091;4670.95329046712;4688.57802797743;4707.929381059287;3686.2627474505207;3771.07608635886;3789.033796381905;3791.905202369963;3793;630.5649102119523;635.4249404289126;642.7075680565332;643.8990564402344;644.9419552240321;753.3408267765705;783.4633276205817;791.8020494876281;795.9363250939911;801.531104303977;10373.84439233412;10502.947485262524;10717.83923241152;10949.233553651167;10986.230963832615;761.7143571160815;786.130623225221;794.3010151067024;804.7786858613928;806.6128258435983;5099.5410413063;5197.376314842243;5203.14148165556;5208.947910520847;5237.214417837355;85155.57422212973;85219.5739021301;87925;89185;89596;57965;60327.69836150879;67414.66292668604;71723.99999999895;74115.62942185254;52696.20955685591;55109.520071596875;63099.6845015772;64846.35153648497;65238;11017.1186305097;11647.417629118341;11880.021371255647;11890.28658280506;12028.699282517657;39557.40663890102;39954.80022599868;40776.59223407728;41416.964575885846;42101.36847947344;41321.79339103285;41626;44958.77520612376;49642.751786240835;50118.74940625273;13825.930870345584;13857.930710346383;14107;14109.6472588182;14219.360128794437;14632.634184145481;15394.07635541871;15548.98387947948;15753.921230393775;15754.68490630158;12756.744865102832;14563.85436145625;15436.996595221724;15610;16331.83668163303;14857.702845943237;15033.548993530212;15230.619234519225;15561.688766224386;15786.842131578996;14684.118952862862;14998.2500874958;15156.24218789034;15212.771808423104;15262.694746105239;12080.879191207976;12222.327771972627;12978.351082445652;13246.933765331112;13484.32578371058;12242.081843861924;12263.82703455847;12394.566190183301;12598.811017834923;12615.621531354074 08:34:33 INFO - PROCESS | 4817 | __end_tp_report 08:34:33 INFO - PROCESS | 4817 | __start_cc_report 08:34:33 INFO - PROCESS | 4817 | _x_x_mozilla_cycle_collect,981 08:34:33 INFO - PROCESS | 4817 | __end_cc_report 08:34:33 INFO - PROCESS | 4817 | __startTimestamp1488126873605__endTimestamp 08:34:33 INFO - PROCESS | 4817 | 08:34:33 INFO - PROCESS | 4817 | ------- Summary: start ------- 08:34:33 INFO - PROCESS | 4817 | Number of tests: 6 08:34:33 INFO - PROCESS | 4817 | 08:34:33 INFO - PROCESS | 4817 | [#0] dojo.html Cycles:165 Average:5501.87 Median:5717.03 stddev:600.79 (10.5%) stddev-sans-first:577.59 08:34:33 INFO - PROCESS | 4817 | Values: 3313.8 3344.5 3355.4 3373.0 3390.5 5432.4 5512.7 5521.2 5523.5 5553.8 5513.2 5568.0 5574.7 5584.7 5617.4 5048.6 5068.7 5105.1 5148.0 5166.9 4931.6 5105.1 5156.8 5161.2 5161.6 4916.8 4955.3 4973.2 5003.9 5084.9 5060.7 5101.4 5102.3 5104.9 5133.8 4848.3 5011.4 5014.2 5078.3 5090.0 5387.0 5391.3 5474.2 5500.6 5570.6 5926.6 5930.1 5934.3 5934.7 5937.8 5942.7 5952.6 5964.6 5971.1 5976.2 5412.6 5451.1 5461.8 5501.2 5573.3 6016.5 6020.3 6020.6 6041.2 6043.7 5775.4 5830.8 5841.7 5844.9 5848.9 5748.4 5784.4 5790.7 5849.4 5906.8 5841.6 5881.5 5882.0 5909.6 5926.1 5837.4 5839.2 5841.4 5842.7 5849.5 4483.9 4504.9 4546.8 4551.9 4553.6 4014.5 4053.6 4076.6 4081.1 4085.8 5677.9 5678.1 5680.1 5680.3 5717.0 5655.7 5748.0 5856.2 5905.8 5908.5 5745.9 5748.3 5752.0 5757.1 5778.0 5062.3 5069.2 5077.5 5078.5 5078.6 6021.7 6063.8 6098.1 6168.7 6181.1 5919.3 5982.7 5988.1 6003.7 6025.2 6186.7 6193.5 6194.8 6196.3 6197.2 5671.9 5688.5 5827.3 5886.8 5888.0 5866.7 5882.1 5904.7 5923.9 6000.2 5805.7 5808.9 5811.0 5814.1 5814.8 5655.2 5817.1 5820.4 5823.7 5824.1 5588.3 5627.1 5659.1 5663.6 5752.9 5754.5 5763.6 5770.5 5772.0 5772.3 5629.4 5633.4 5642.6 5646.3 5648.7 08:34:33 INFO - PROCESS | 4817 | 08:34:33 INFO - PROCESS | 4817 | [#1] ext.html Cycles:180 Average:61179.07 Median:41214.80 stddev:109856.10 (266.5%) stddev-sans-first:110069.99 08:34:33 INFO - PROCESS | 4817 | Values: 560.4 586.9 605.0 611.1 642.3 39304.4 40133.0 40181.8 40259.4 47525.5 51368.7 52013.0 52098.2 52268.0 52454.0 9184.1 9413.8 9419.2 9423.2 9442.6 8805.8 8989.6 9334.3 9459.3 10896.5 11000.9 11391.9 11409.8 11410.1 11413.7 11273.6 11322.8 11375.1 11387.2 11387.7 11277.7 11337.8 11348.4 11355.0 11355.2 48771.3 48905.0 48956.8 49095.5 49158.8 4419.7 4424.4 4462.4 4570.6 4594.3 31528.2 31787.5 34312.5 35266.8 36903.8 4532.1 4583.2 4591.1 4618.6 4664.5 365407.0 366226.0 368229.0 369664.0 371261.0 71044.0 71295.6 71435.6 71509.3 71535.6 73120.3 73241.0 73262.6 73906.3 73917.6 19592.1 20166.9 20196.3 20200.3 20227.8 14563.9 14595.9 14600.2 14606.6 14608.5 18567.7 18978.2 19669.5 20268.9 20423.4 6638.7 6640.9 6700.9 6749.4 6873.9 972.0 979.9 985.3 1000.7 1011.6 33248.0 33303.5 33384.0 33658.5 34151.1 1059.9 1133.2 1135.9 1139.2 1173.0 17028.2 18374.6 18377.2 18429.3 18484.8 477917.2 478243.0 478884.0 481838.0 484169.0 68853.7 68939.3 68999.7 69085.0 69177.7 1496.8 1503.6 1536.7 1539.4 1551.4 31045.7 32735.7 32786.0 32790.0 33159.2 58686.4 59059.0 59218.4 59429.0 59468.0 393029.0 394087.0 396022.0 396784.0 397737.0 40345.0 41594.0 45663.5 45773.1 46454.5 58623.0 59602.7 59689.0 59839.7 60194.4 43905.3 46219.8 46586.3 46978.8 47383.5 38368.0 42313.4 43436.8 45766.0 47691.8 40437.8 40835.6 41595.4 42021.4 42323.8 33430.0 35930.8 36309.5 36611.3 37058.4 26837.6 26937.3 27161.5 27163.3 27249.6 08:34:33 INFO - PROCESS | 4817 | 08:34:33 INFO - PROCESS | 4817 | [#2] jquery.html Cycles:180 Average:36969.19 Median:14315.89 stddev:116272.62 (812.2%) stddev-sans-first:116566.43 08:34:33 INFO - PROCESS | 4817 | Values: 431.6 442.4 445.6 445.6 457.3 19698.2 20387.8 21286.6 21357.9 21437.1 21903.8 22991.4 23092.2 23099.5 23251.7 5945.8 6018.8 6203.6 6208.5 6209.1 5946.1 6122.2 6126.2 6129.8 6131.4 5896.7 6055.5 6078.5 6101.1 6105.9 6060.2 6112.9 6113.6 6120.0 6121.4 5381.8 5470.3 5485.0 5501.4 5523.2 24323.0 24454.1 26081.0 26884.7 27187.7 2550.8 2642.1 2642.5 2672.5 2702.3 11240.5 11432.7 11777.6 11879.5 14033.9 1957.2 2005.3 2015.1 2027.2 2054.4 104168.0 104213.5 104393.0 104663.5 106837.0 12511.9 12518.7 12591.2 12696.9 12923.1 18177.3 18187.6 18188.3 18222.7 18231.0 9346.5 9488.3 9555.8 9602.9 9657.8 9130.7 9134.5 9141.6 9168.6 9374.2 5498.3 5507.8 5531.9 5548.4 5589.6 2170.7 2230.4 2259.2 2264.6 2279.3 921.2 922.4 933.8 947.1 953.7 19411.8 19769.1 20544.3 20881.7 21112.9 943.5 945.8 955.5 962.9 979.1 10812.1 11243.3 11320.4 11325.4 11466.3 691787.0 701896.0 711903.0 714392.0 720659.0 85239.6 85437.0 109697.5 109984.0 112366.0 1138.2 1163.7 1164.2 1167.5 1180.9 19312.9 19679.3 19705.4 19743.3 19747.7 38865.0 43980.8 44059.6 44116.0 44542.0 58466.0 62242.3 63401.0 63409.4 64643.0 9588.7 9689.7 9716.7 9850.4 9870.2 14824.3 14839.2 15008.8 15291.9 15485.3 6383.4 12373.7 12676.6 12762.7 12766.4 12058.3 12137.9 12439.9 12553.4 12973.9 12486.8 12583.4 12704.9 12746.7 12878.2 9479.1 9683.9 9685.5 9812.6 10141.4 12538.4 12569.2 12578.7 12593.9 12771.4 08:34:33 INFO - PROCESS | 4817 | 08:34:33 INFO - PROCESS | 4817 | [#3] mootools.html Cycles:180 Average:5622.34 Median:5100.13 stddev:3051.14 (59.8%) stddev-sans-first:3042.75 08:34:33 INFO - PROCESS | 4817 | Values: 1343.5 1472.9 1479.8 1502.7 1503.8 7593.2 7793.5 8080.6 8081.1 8327.0 8126.6 8201.6 8203.8 8205.5 8207.1 2075.6 2147.4 2150.0 2381.2 2417.2 2158.4 2387.6 2460.6 2465.1 2473.6 2362.6 2381.5 2382.1 2382.9 2384.2 2280.5 2314.3 2316.3 2317.5 2317.9 2349.0 2351.2 2417.4 2421.6 2425.2 8381.2 8417.5 8429.3 8432.0 8438.7 5261.3 5397.6 5406.1 5406.2 5408.1 3131.3 3276.4 3382.5 3395.3 3397.4 1269.9 1337.5 1373.3 1391.7 1450.1 11511.2 11575.1 11601.7 11602.3 11626.5 4525.7 4761.4 4833.8 4834.2 4842.9 9967.1 9971.2 9984.3 9986.1 9997.3 5441.7 5459.1 5459.7 5459.8 5465.0 4388.1 4887.0 4928.3 4983.7 4998.2 3795.8 4026.0 4139.3 4193.6 4194.9 1310.3 1311.3 1323.7 1327.7 1329.2 934.3 984.0 991.9 1000.0 1015.5 5684.5 5903.3 5986.9 6016.4 6272.4 1021.8 1074.0 1082.8 1085.6 1107.2 3961.5 3997.3 4025.2 4035.4 4049.0 10160.3 10452.2 10473.4 10476.2 10477.0 10413.5 10420.1 10541.9 10547.5 10560.1 7589.3 8002.3 8003.1 8028.8 8129.9 5714.6 5839.3 5944.6 5954.2 5981.1 9194.0 9244.7 9259.1 9380.5 9454.0 9019.9 9176.4 9285.1 9453.8 9454.2 7534.8 7631.5 7647.6 7704.5 7731.6 8132.1 8191.6 8208.3 8211.5 8214.7 7304.8 7322.7 7352.6 7406.3 7553.3 7045.1 7077.4 7121.0 7136.8 7186.4 6553.1 6574.8 6597.6 6599.8 6600.0 5085.2 5086.0 5164.7 5259.1 5290.6 5033.6 5043.7 5114.3 5152.9 5221.5 08:34:33 INFO - PROCESS | 4817 | 08:34:33 INFO - PROCESS | 4817 | [#4] prototype.html Cycles:180 Average:4797.27 Median:5384.08 stddev:1336.82 (24.8%) stddev-sans-first:1299.22 08:34:33 INFO - PROCESS | 4817 | Values: 401.7 403.0 408.7 413.5 419.5 5411.6 5468.4 5468.9 5477.7 5479.2 5265.5 5342.3 5382.0 5386.2 5453.2 4306.7 4362.8 4378.3 4380.5 4389.6 4380.8 4381.4 4384.0 4393.8 4394.4 4280.6 4315.8 4336.6 4345.3 4350.6 4308.4 4334.5 4335.5 4336.4 4342.5 3958.8 3972.1 3982.1 3997.2 4014.1 5134.0 5245.2 5274.3 5277.0 5340.4 4997.3 4998.4 4999.7 5014.9 5046.7 5710.5 5713.8 5715.6 5753.1 5759.6 4288.8 4319.3 4332.9 4378.1 4415.4 5616.9 5773.9 5826.0 5846.8 5881.4 4374.9 4461.4 4461.6 4463.4 4477.2 4278.3 4525.5 4527.3 4532.3 4554.4 4849.0 4881.9 4934.5 4970.4 4998.4 5623.8 5643.9 5649.7 5681.7 5703.3 1467.4 1514.4 1526.8 1528.8 1543.9 1067.8 1085.9 1095.7 1100.3 1116.9 5345.0 5355.5 5359.8 5370.3 5378.6 5604.5 5610.8 5625.4 5678.7 5689.8 5236.3 5396.3 5421.7 5430.4 5546.8 2974.9 2983.5 2985.6 2987.7 2997.2 5793.3 5804.4 5835.9 5847.8 5864.8 5498.0 5723.0 5724.3 5732.7 5763.7 5832.7 5838.3 5842.0 5844.3 5888.9 5351.4 5562.2 5587.8 5642.6 5685.9 5547.4 5572.9 5578.8 5578.9 5579.7 5752.6 5817.5 5870.4 5979.5 6009.1 4187.0 4199.4 4214.7 4230.7 4256.3 5748.0 5817.8 5831.7 5837.0 5857.0 5617.7 5618.9 5625.0 5627.8 5636.7 5629.1 5635.9 5637.7 5664.7 5677.9 5407.6 5573.4 5622.3 5622.7 5628.9 5604.9 5613.3 5623.4 5654.5 5660.5 5356.3 5514.2 5526.2 5564.8 5610.6 08:34:33 INFO - PROCESS | 4817 | 08:34:33 INFO - PROCESS | 4817 | [#5] yui.html Cycles:180 Average:18172.63 Median:41863.68 stddev:22873.82 (54.6%) stddev-sans-first:22900.65 08:34:33 INFO - PROCESS | 4817 | Values: 769.5 787.6 800.2 867.5 920.4 15404.6 15929.4 16115.4 16332.2 16644.3 14799.0 14999.9 15024.6 15214.2 15363.8 705.2 825.7 835.0 835.7 836.6 730.8 794.3 828.8 831.8 833.3 861.1 862.0 862.8 862.8 863.2 717.4 854.1 856.6 857.3 857.8 556.9 604.4 630.7 634.3 636.0 15843.6 15848.2 15899.4 15916.5 15942.0 13256.2 13573.5 13774.8 13822.2 15084.3 13703.5 13799.8 14287.4 14343.9 14650.1 4707.6 4742.4 4765.2 4908.0 4949.7 84575.6 84739.2 85585.1 87747.6 87967.6 12344.6 12550.0 12563.9 12576.1 12587.4 23649.2 23688.9 23825.2 24048.5 24450.1 8440.7 8512.4 8560.2 8564.4 8703.7 4597.8 4605.3 4671.0 4688.6 4707.9 3686.3 3771.1 3789.0 3791.9 3793.0 630.6 635.4 642.7 643.9 644.9 753.3 783.5 791.8 795.9 801.5 10373.8 10502.9 10717.8 10949.2 10986.2 761.7 786.1 794.3 804.8 806.6 5099.5 5197.4 5203.1 5208.9 5237.2 85155.6 85219.6 87925.0 89185.0 89596.0 57965.0 60327.7 67414.7 71724.0 74115.6 52696.2 55109.5 63099.7 64846.4 65238.0 11017.1 11647.4 11880.0 11890.3 12028.7 39557.4 39954.8 40776.6 41417.0 42101.4 41321.8 41626.0 44958.8 49642.8 50118.7 13825.9 13857.9 14107.0 14109.6 14219.4 14632.6 15394.1 15549.0 15753.9 15754.7 12756.7 14563.9 15437.0 15610.0 16331.8 14857.7 15033.5 15230.6 15561.7 15786.8 14684.1 14998.3 15156.2 15212.8 15262.7 12080.9 12222.3 12978.4 13246.9 13484.3 12242.1 12263.8 12394.6 12598.8 12615.6 08:34:33 INFO - PROCESS | 4817 | -------- Summary: end -------- 08:34:33 INFO - PROCESS | 4817 | 08:34:34 INFO - TEST-INFO | 4817: exit 0 08:34:34 INFO - TEST-OK | dromaeo_css | took 1114657ms 08:34:34 INFO - TEST-START | kraken 08:34:34 INFO - operating with platform_type : linux_ 08:34:34 INFO - Initialising browser for kraken test... 08:34:34 INFO - TEST-INFO | started process 5134 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpBZSbnI/profile http://localhost:55905/getInfo.html) 08:34:38 INFO - PROCESS | 5134 | __metrics Screen width/height:1600/1200 08:34:38 INFO - PROCESS | 5134 | colorDepth:24 08:34:38 INFO - PROCESS | 5134 | Browser inner width/height: 1024/697 08:34:38 INFO - PROCESS | 5134 | __metrics 08:34:39 INFO - PROCESS | 5134 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:34:39 INFO - PROCESS | 5134 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:34:40 INFO - TEST-INFO | 5134: exit 0 08:34:40 INFO - Browser initialized. 08:34:40 INFO - Running cycle 1/1 for kraken test... 08:34:40 INFO - TEST-INFO | started process 5227 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpBZSbnI/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:34:52 INFO - PROCESS | 5227 | RSS: Main: 138240000 08:34:52 INFO - PROCESS | 5227 | 08:34:54 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55905/tests/kraken/driver.html?testName=audio-beat-detection) 08:34:55 INFO - PROCESS | 5227 | RSS: Main: 181448704 08:34:55 INFO - PROCESS | 5227 | 08:34:58 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55905/tests/kraken/driver.html?testName=audio-dft) 08:34:58 INFO - PROCESS | 5227 | RSS: Main: 172523520 08:34:58 INFO - PROCESS | 5227 | 08:35:01 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55905/tests/kraken/driver.html?testName=audio-fft) 08:35:02 INFO - PROCESS | 5227 | RSS: Main: 263696384 08:35:02 INFO - PROCESS | 5227 | 08:35:04 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55905/tests/kraken/driver.html?testName=audio-oscillator) 08:35:04 INFO - PROCESS | 5227 | RSS: Main: 169836544 08:35:04 INFO - PROCESS | 5227 | 08:35:06 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55905/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:35:07 INFO - PROCESS | 5227 | RSS: Main: 172376064 08:35:07 INFO - PROCESS | 5227 | 08:35:10 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55905/tests/kraken/driver.html?testName=imaging-darkroom) 08:35:10 INFO - PROCESS | 5227 | RSS: Main: 208162816 08:35:10 INFO - PROCESS | 5227 | 08:35:14 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55905/tests/kraken/driver.html?testName=imaging-desaturate) 08:35:14 INFO - PROCESS | 5227 | RSS: Main: 209416192 08:35:14 INFO - PROCESS | 5227 | 08:35:17 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55905/tests/kraken/driver.html?testName=json-parse-financial) 08:35:18 INFO - PROCESS | 5227 | RSS: Main: 207847424 08:35:18 INFO - PROCESS | 5227 | 08:35:19 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55905/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:35:20 INFO - PROCESS | 5227 | RSS: Main: 170799104 08:35:20 INFO - PROCESS | 5227 | 08:35:21 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55905/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:35:22 INFO - PROCESS | 5227 | RSS: Main: 177295360 08:35:22 INFO - PROCESS | 5227 | 08:35:24 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55905/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:35:25 INFO - PROCESS | 5227 | RSS: Main: 186093568 08:35:25 INFO - PROCESS | 5227 | 08:35:27 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55905/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:35:28 INFO - PROCESS | 5227 | RSS: Main: 195579904 08:35:28 INFO - PROCESS | 5227 | 08:35:31 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55905/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:35:31 INFO - PROCESS | 5227 | RSS: Main: 192200704 08:35:31 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | Cycle 1(1): loaded http://localhost:55905/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55905/tests/kraken/driver.html?testName=ai-astar) 08:35:33 INFO - PROCESS | 5227 | RSS: Main: 244686848 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | __start_tp_report 08:35:33 INFO - PROCESS | 5227 | _x_x_mozilla_page_load 08:35:33 INFO - PROCESS | 5227 | _x_x_mozilla_page_load_details 08:35:33 INFO - PROCESS | 5227 | |i|pagename|runs| 08:35:33 INFO - PROCESS | 5227 | |0;ai-astar;110;110;109;111;111;112;111;110;111;111 08:35:33 INFO - PROCESS | 5227 | |1;audio-beat-detection;142;118;119;150;118;118;120;121;137;118 08:35:33 INFO - PROCESS | 5227 | |2;audio-dft;159;161;159;160;159;158;161;160;159;158 08:35:33 INFO - PROCESS | 5227 | |3;audio-fft;75;75;75;107;76;77;76;76;91;76 08:35:33 INFO - PROCESS | 5227 | |4;audio-oscillator;83;83;110;83;84;83;96;83;82;112 08:35:33 INFO - PROCESS | 5227 | |5;imaging-gaussian-blur;116;117;117;116;116;116;117;117;117;116 08:35:33 INFO - PROCESS | 5227 | |6;imaging-darkroom;146;146;146;146;146;146;146;146;146;146 08:35:33 INFO - PROCESS | 5227 | |7;imaging-desaturate;96;95;95;95;95;95;95;95;95;94 08:35:33 INFO - PROCESS | 5227 | |8;json-parse-financial;48;50;48;48;49;48;49;48;53;49 08:35:33 INFO - PROCESS | 5227 | |9;json-stringify-tinderbox;63;62;63;63;63;63;63;63;63;63 08:35:33 INFO - PROCESS | 5227 | |10;stanford-crypto-aes;76;75;75;84;80;81;90;76;76;76 08:35:33 INFO - PROCESS | 5227 | |11;stanford-crypto-ccm;131;139;123;123;126;134;117;124;152;128 08:35:33 INFO - PROCESS | 5227 | |12;stanford-crypto-pbkdf2;159;160;157;159;158;160;157;156;153;156 08:35:33 INFO - PROCESS | 5227 | |13;stanford-crypto-sha256-iterative;62;61;61;63;61;62;62;62;60;59 08:35:33 INFO - PROCESS | 5227 | __end_tp_report 08:35:33 INFO - PROCESS | 5227 | __start_cc_report 08:35:33 INFO - PROCESS | 5227 | _x_x_mozilla_cycle_collect,1553 08:35:33 INFO - PROCESS | 5227 | __end_cc_report 08:35:33 INFO - PROCESS | 5227 | __startTimestamp1488126933570__endTimestamp 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | ------- Summary: start ------- 08:35:33 INFO - PROCESS | 5227 | Number of tests: 14 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#0] ai-astar Cycles:10 Average:110.60 Median:111.00 stddev:0.84 (0.8%) stddev-sans-first:0.87 08:35:33 INFO - PROCESS | 5227 | Values: 110.0 110.0 109.0 111.0 111.0 112.0 111.0 110.0 111.0 111.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#1] audio-beat-detection Cycles:10 Average:126.10 Median:120.50 stddev:12.11 (10.0%) stddev-sans-first:11.39 08:35:33 INFO - PROCESS | 5227 | Values: 142.0 118.0 119.0 150.0 118.0 118.0 120.0 121.0 137.0 118.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#2] audio-dft Cycles:10 Average:159.40 Median:159.50 stddev:1.07 (0.7%) stddev-sans-first:1.13 08:35:33 INFO - PROCESS | 5227 | Values: 159.0 161.0 159.0 160.0 159.0 158.0 161.0 160.0 159.0 158.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#3] audio-fft Cycles:10 Average:80.40 Median:76.00 stddev:10.52 (13.8%) stddev-sans-first:10.98 08:35:33 INFO - PROCESS | 5227 | Values: 75.0 75.0 75.0 107.0 76.0 77.0 76.0 76.0 91.0 76.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#4] audio-oscillator Cycles:10 Average:89.90 Median:83.00 stddev:11.86 (14.3%) stddev-sans-first:12.31 08:35:33 INFO - PROCESS | 5227 | Values: 83.0 83.0 110.0 83.0 84.0 83.0 96.0 83.0 82.0 112.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#5] imaging-gaussian-blur Cycles:10 Average:116.50 Median:117.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 08:35:33 INFO - PROCESS | 5227 | Values: 116.0 117.0 117.0 116.0 116.0 116.0 117.0 117.0 117.0 116.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#6] imaging-darkroom Cycles:10 Average:146.00 Median:146.00 stddev:0.00 (0.0%) stddev-sans-first:0.00 08:35:33 INFO - PROCESS | 5227 | Values: 146.0 146.0 146.0 146.0 146.0 146.0 146.0 146.0 146.0 146.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#7] imaging-desaturate Cycles:10 Average:95.00 Median:95.00 stddev:0.47 (0.5%) stddev-sans-first:0.33 08:35:33 INFO - PROCESS | 5227 | Values: 96.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 94.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#8] json-parse-financial Cycles:10 Average:49.00 Median:49.00 stddev:1.56 (3.2%) stddev-sans-first:1.62 08:35:33 INFO - PROCESS | 5227 | Values: 48.0 50.0 48.0 48.0 49.0 48.0 49.0 48.0 53.0 49.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#9] json-stringify-tinderbox Cycles:10 Average:62.90 Median:63.00 stddev:0.32 (0.5%) stddev-sans-first:0.33 08:35:33 INFO - PROCESS | 5227 | Values: 63.0 62.0 63.0 63.0 63.0 63.0 63.0 63.0 63.0 63.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#10] stanford-crypto-aes Cycles:10 Average:78.90 Median:78.00 stddev:4.93 (6.3%) stddev-sans-first:5.12 08:35:33 INFO - PROCESS | 5227 | Values: 76.0 75.0 75.0 84.0 80.0 81.0 90.0 76.0 76.0 76.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#11] stanford-crypto-ccm Cycles:10 Average:129.70 Median:129.50 stddev:10.02 (7.7%) stddev-sans-first:10.62 08:35:33 INFO - PROCESS | 5227 | Values: 131.0 139.0 123.0 123.0 126.0 134.0 117.0 124.0 152.0 128.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:157.50 Median:158.50 stddev:2.17 (1.4%) stddev-sans-first:2.24 08:35:33 INFO - PROCESS | 5227 | Values: 159.0 160.0 157.0 159.0 158.0 160.0 157.0 156.0 153.0 156.0 08:35:33 INFO - PROCESS | 5227 | 08:35:33 INFO - PROCESS | 5227 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:61.30 Median:62.00 stddev:1.16 (1.9%) stddev-sans-first:1.20 08:35:33 INFO - PROCESS | 5227 | Values: 62.0 61.0 61.0 63.0 61.0 62.0 62.0 62.0 60.0 59.0 08:35:33 INFO - PROCESS | 5227 | -------- Summary: end -------- 08:35:33 INFO - PROCESS | 5227 | 08:35:34 INFO - TEST-INFO | 5227: exit 0 08:35:34 INFO - TEST-OK | kraken | took 60214ms 08:35:34 INFO - SUITE-END | took 1174s 08:35:34 INFO - Completed test suite (00:19:34) 08:35:34 INFO - javascript benchmark 08:35:34 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3313.834308284586, 3344.48160535117, 3355.4463513520272, 3373.0218236711353, 3390.4744764561488, 5432.402435732071, 5512.72436378181, 5521.199426083221, 5523.502884740373, 5553.805616803413, 5513.228148059265, 5567.972160139194, 5574.721263936797, 5584.692841893694, 5617.4382561743805, 5048.621353398501, 5068.72122033288, 5105.05556472052, 5147.974260128694, 5166.870828229286, 4931.556159945604, 5105.106606343894, 5156.819511317105, 5161.225816127573, 5161.612879034069, 4916.778744956486, 4955.306257124005, 4973.154563724175, 5003.899922001558, 5084.872878178038, 5060.671056381323, 5101.362329708786, 5102.260172275, 5104.948950510485, 5133.794648214067, 4848.2727590861305, 5011.398632164163, 5014.197728363481, 5078.26365177051, 5089.982003599295, 5387.0, 5391.299131112969, 5474.206240095164, 5500.559955203614, 5570.610057295991, 5926.585139040269, 5930.080837470199, 5934.317553481362, 5934.673592952386, 5937.762489500415, 5942.673152976585, 5952.613080149819, 5964.612300200516, 5971.104334349839, 5976.193213916109, 5412.621116521845, 5451.100568406208, 5461.808836690737, 5501.174823776386, 5573.303337082864, 6016.458518733335, 6020.277566692025, 6020.578559500793, 6041.184440100618, 6043.667598282137, 5775.364709881909, 5830.7959221427045, 5841.7371218295275, 5844.853878653068, 5848.88302233953, 5748.39641837601, 5784.421557844266, 5790.652560846363, 5849.444302791228, 5906.822795316061, 5841.649501029951, 5881.470667639933, 5881.9705901470215, 5909.5863289569315, 5926.081457374114, 5837.357890632027, 5839.211706419579, 5841.386654401312, 5842.707864606753, 5849.53203743708, 4483.865484035484, 4504.932426013613, 4546.840860569864, 4551.886202844956, 4553.590176884097, 4014.5383280922483, 4053.635172834459, 4076.6331030207425, 4081.10215752534, 4085.754854708727, 5677.914831277534, 5678.14827775837, 5680.091185410314, 5680.289963754531, 5717.028105222123, 5655.7454914528125, 5748.02283611787, 5856.1508581255475, 5905.763769449174, 5908.468237858613, 5745.9425405745405, 5748.31020277561, 5752.0, 5757.107648314518, 5778.046622307273, 5062.316587260672, 5069.163588008011, 5077.492250774893, 5078.492150784966, 5078.568321692624, 6021.668808215591, 6063.757449701962, 6098.11577321277, 6168.722407491674, 6181.103739957771, 5919.289685237799, 5982.700864956648, 5988.131720900532, 6003.6998150093195, 6025.186599809145, 6186.721597528212, 6193.504519638508, 6194.81415557534, 6196.318404975539, 6197.194364732556, 5671.914921276101, 5688.516476099578, 5827.271591051119, 5886.793962211302, 5888.0, 5866.67733274674, 5882.058870580858, 5904.734286957011, 5923.911141332969, 6000.189974353407, 5805.651660900359, 5808.883822323614, 5811.041178205549, 5814.098814683731, 5814.825555233349, 5655.208270842168, 5817.127430885401, 5820.388859169726, 5823.7379317931645, 5824.068149096124, 5588.30146231721, 5627.099664053731, 5659.094544872801, 5663.57523185771, 5752.856178595569, 5754.4533269339345, 5763.625364351471, 5770.480656740746, 5772.0, 5772.278465191851, 5629.437056294338, 5633.3521645009705, 5642.60501764889, 5646.322441306905, 5648.689322087324], "value": 5463.538671473727, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [560.3813350666745, 586.8796896636188, 604.9685286586373, 611.1321922869524, 642.2549842183063, 39304.41043384348, 40133.0, 40181.79909100454, 40259.39610905832, 47525.52474475254, 51368.74315628426, 52013.0, 52098.218526722034, 52268.0, 52454.0, 9184.127507886757, 9413.81172376552, 9419.199368053723, 9423.199028082621, 9442.622295108187, 8805.779855503599, 8989.550522473883, 9334.346595738301, 9459.337846350758, 10896.509657065451, 11000.944995275053, 11391.943040284787, 11409.828852567218, 11410.144239182053, 11413.657590272263, 11273.605423810168, 11322.830157547643, 11375.146863985234, 11387.202895797298, 11387.715307117305, 11277.661670149908, 11337.829932551018, 11348.375839328834, 11355.034822040136, 11355.205135640508, 48771.26843097356, 48905.0, 48956.75521622369, 49095.509044909806, 49158.754206229096, 4419.690621656486, 4424.358468022118, 4462.419885414908, 4570.634349252052, 4594.310853372021, 31528.211794705087, 31787.523187152212, 34312.48531272033, 35266.82366588151, 36903.81548092242, 4532.116237333721, 4583.220852455091, 4591.104734576759, 4618.607418369443, 4664.463586687541, 365407.0, 366226.0, 368229.0, 369664.0, 371260.9999999973, 71044.0, 71295.64352178205, 71435.64282178556, 71509.2849071513, 71535.64232178805, 73120.26879731241, 73241.0, 73262.63368683122, 73906.26093739101, 73917.6304118476, 19592.11835467379, 20166.899165504372, 20196.29312974039, 20200.29298974529, 20227.797722022886, 14563.854361456462, 14595.854041459663, 14600.196989165697, 14606.63483412902, 14608.48870289556, 18567.721484177477, 18978.24087036503, 19669.50826229356, 20268.898655506924, 20423.387298381072, 6638.701258443381, 6640.933590664032, 6700.899486507707, 6749.426298764562, 6873.872388063419, 971.9757006074905, 979.8873129590188, 985.2708995343394, 1000.73407139968, 1011.5549158370294, 33248.0, 33303.50044749331, 33384.0, 33658.49512257318, 34151.14622134417, 1059.86751656043, 1133.2294040052843, 1135.920485566019, 1139.2424038014628, 1172.9648110556698, 17028.233729482203, 18374.63250734978, 18377.17302721381, 18429.26282948667, 18484.81515184831, 477917.2208277942, 478243.0, 478884.0, 481838.0, 484169.0, 68853.65573172102, 68939.31060689429, 68999.65500172468, 69085.0, 69177.65411172912, 1496.8428315026765, 1503.6466430389069, 1536.7464368379315, 1539.4304107480305, 1551.3794482207206, 31045.68954310518, 32735.67264327326, 32786.0, 32790.0, 33159.17102072371, 58686.4131358698, 59059.0, 59218.40781592301, 59429.0, 59468.0, 393029.0, 394087.0, 396022.0, 396784.0, 397737.0, 40345.0, 41594.0, 45663.54336456593, 45773.08453830971, 46454.53545464502, 58623.0, 59602.70198648979, 59689.0, 59839.70080149572, 60194.39805602063, 43905.34141987937, 46219.768901156625, 46586.301205482625, 46978.76510617562, 47383.52616473791, 38368.0, 42313.365299521145, 43436.78281608572, 45766.0, 47691.76154119346, 40437.79781101076, 40835.59164408318, 41595.37606935959, 42021.36967945422, 42323.7883810579, 33430.0, 35930.8203458981, 36309.45535816912, 36611.26777464383, 37058.44412333871, 26837.597436038865, 26937.326566835985, 27161.45677086487, 27163.320916977234, 27249.591256130778], "value": 22074.123344438278, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [431.5641202385593, 442.4403130040499, 445.55889669227463, 445.64571165923087, 457.3026135143905, 19698.21207151714, 20387.796122038777, 21286.57426851462, 21357.893210533926, 21437.14251429943, 21903.780962190413, 22991.42521436965, 23092.191773287937, 23099.538009239805, 23251.651225231635, 5945.821625351246, 6018.759249630009, 6203.565750397474, 6208.472279856195, 6209.068639704035, 5946.108083787445, 6122.234720659918, 6126.23422072241, 6129.816105516819, 6131.3562075982045, 5896.7051647417675, 6055.515558755311, 6078.5441091918065, 6101.145839582462, 6105.938940610604, 6060.181875446824, 6112.938870611326, 6113.602615829956, 6120.0, 6121.3572574879445, 5381.811636592701, 5470.316210473691, 5484.972575137099, 5501.394846566875, 5523.199136125279, 24323.0, 24454.14410495624, 26081.0, 26884.73115268842, 27187.728122718916, 2550.7831834294107, 2642.101685426964, 2642.524345617788, 2672.5055864664905, 2702.2568793581727, 11240.49417776202, 11432.71418214543, 11777.646670599896, 11879.524819007229, 14033.929830350886, 1957.168203513501, 2005.2780998840406, 2015.083137172583, 2027.1789925080366, 2054.445299769054, 104168.0, 104213.4789326056, 104393.0, 104663.47668261686, 106837.0, 12511.937440312922, 12518.687032824253, 12591.24452532851, 12696.87303126957, 12923.095383323265, 18177.272909083753, 18187.63624727498, 18188.272469101354, 18222.726659100124, 18231.0, 9346.48594327305, 9488.335816492918, 9555.754397716531, 9602.9039709602, 9657.806843863083, 9130.680426185052, 9134.492808686626, 9141.588628511732, 9168.633254669738, 9374.156325930699, 5498.340199176045, 5507.752151153128, 5531.889362212733, 5548.361938377057, 5589.5807814413265, 2170.7192756273557, 2230.408941630469, 2259.209276753123, 2264.5584111098506, 2279.316205138452, 921.235374639048, 922.3866129024124, 933.803901180746, 947.1002547579827, 953.68051702679, 19411.805881941284, 19769.11039003248, 20544.28095016667, 20881.68677469839, 21112.894435528033, 943.5329511891657, 945.8061097475002, 955.5317894231777, 962.8844538655406, 979.0894468144694, 10812.080973117216, 11243.325400475998, 11320.37737924422, 11325.433728313552, 11466.2546934449, 691787.0, 701896.0, 711903.0, 714392.0, 720659.0, 85239.57380213184, 85437.0, 109697.45151274193, 109984.0, 112366.0, 1138.2373809547623, 1163.668354518958, 1164.2083383299268, 1167.480471190312, 1180.913559525239, 19312.90343548273, 19679.31122410709, 19705.408837734893, 19743.308984185485, 19747.703784442958, 38865.0, 43980.78009609931, 44059.55940440555, 44116.0, 44541.999999998705, 58466.0, 62242.2654640723, 63401.0, 63409.36590634035, 64643.03035454566, 9588.66439674608, 9689.70930872075, 9716.659916902874, 9850.408975461496, 9870.161036311994, 14824.332905019515, 14839.183844888636, 15008.849911500745, 15291.923540382228, 15485.303161357991, 6383.39357761012, 12373.690657733629, 12676.619701408972, 12762.744745104861, 12766.425510851848, 12058.336791476553, 12137.939310303746, 12439.937800310941, 12553.372331383212, 12973.870261297267, 12486.750264994467, 12583.370831458573, 12704.936475317565, 12746.68133296675, 12878.227306361649, 9479.146876781122, 9683.854742179014, 9685.467299298607, 9812.55843487059, 10141.442220677933, 12538.435770390537, 12569.245845249314, 12578.685532861751, 12593.874061259638, 12771.361431928552], "value": 10197.982567129802, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1343.5431953135933, 1472.860078292562, 1479.8076250087488, 1502.6919481506288, 1503.7593984962402, 7593.240675932404, 7793.53238805672, 8080.636371363295, 8081.070676872161, 8327.0, 8126.553039582821, 8201.58992050398, 8203.753887383373, 8205.507669539817, 8207.138250483702, 2075.6471399861985, 2147.44166516706, 2149.967750483744, 2381.1665916929064, 2417.226487523993, 2158.384860314811, 2387.606045002581, 2460.6063029915217, 2465.100238412975, 2473.6413220083077, 2362.586547354215, 2381.4641705616273, 2382.0590866607768, 2382.880855957204, 2384.2489615771065, 2280.4754906371545, 2314.2941402872116, 2316.281952594701, 2317.5249073939804, 2317.918872839451, 2348.976510234893, 2351.1535847095033, 2417.395651087228, 2421.624648179535, 2425.2360506440414, 8381.203785640355, 8417.494950303002, 8429.283510901581, 8432.0, 8438.746837594881, 5261.342332208474, 5397.649152805055, 5406.053940560386, 5406.243125962368, 5408.080626293539, 3131.2954585218145, 3276.3774882772195, 3382.475716263983, 3395.2530443302435, 3397.3884700753856, 1269.904757143218, 1337.5184933424057, 1373.3270697358323, 1391.6660001599544, 1450.1226757811478, 11511.194216404854, 11575.13186511015, 11601.651950441415, 11602.303861768236, 11626.476808543635, 4525.728456292567, 4761.35721677576, 4833.806647734122, 4834.226523756182, 4842.927356089662, 9967.10296073357, 9971.152452041513, 9984.301098923152, 9986.051325124101, 9997.300188986846, 5441.700706461183, 5459.099248623933, 5459.672419654754, 5459.808906688327, 5465.0, 4388.1223755249075, 4887.0, 4928.285398617252, 4983.6760610560195, 4998.150314446553, 3795.753276037104, 4025.9597404025585, 4139.337705967031, 4193.580641935843, 4194.895127621834, 1310.2531557012412, 1311.302914943984, 1323.6823162441137, 1327.6548097494529, 1329.2091205732575, 934.3039435620507, 983.9852402213972, 991.9057689519484, 1000.034966257565, 1015.4668798880499, 5684.54523638108, 5903.321118071477, 5986.850328741816, 6016.428439298347, 6272.40412160844, 1021.8262895307815, 1073.9570417183381, 1082.821334479802, 1085.647164671485, 1107.1917500224881, 3961.485006949136, 3997.2605068062503, 4025.2352053109817, 4035.4350390944705, 4048.959510404917, 10160.33957792741, 10452.216083793746, 10473.423961682181, 10476.214283928735, 10477.0, 10413.479326033668, 10420.06219440254, 10541.894581054245, 10547.525361358757, 10560.102391296672, 7589.279018493235, 8002.319802816709, 8003.119656837744, 8028.839423211503, 8129.918700813035, 5714.5999780015, 5839.328477225004, 5944.613600115978, 5954.225950626565, 5981.102834574848, 9193.954030229806, 9244.722658320261, 9259.074092590687, 9380.48407337603, 9454.0, 9019.864702029343, 9176.44941303524, 9285.117913798178, 9453.810923781624, 9454.196393306645, 7534.773956781305, 7631.465797394351, 7647.579383133981, 7704.537727736129, 7731.574763388067, 8132.064812546396, 8191.590420478833, 8208.302294305051, 8211.548364839753, 8214.671413143646, 7304.817379565553, 7322.670479828314, 7352.558846469229, 7406.296401841816, 7553.32020118192, 7045.11936007999, 7077.363037326665, 7120.964395178198, 7136.785896423115, 7186.425085993213, 6553.082568440517, 6574.8356291091195, 6597.637129957899, 6599.8020059398295, 6600.0, 5085.160948443613, 5086.0, 5164.664296820694, 5259.053370393366, 5290.629655924048, 5033.597312215087, 5043.697378157322, 5114.258432527188, 5152.948470515397, 5221.503957124067], "value": 4593.952664138812, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [401.7167896632874, 402.9717919745617, 408.7179845906323, 413.5389041219042, 419.4756554307116, 5411.594130440218, 5468.425815289397, 5468.863278418036, 5477.726113694319, 5479.232907392959, 5265.526102650761, 5342.332208473941, 5382.0, 5386.165144402614, 5453.15476101204, 4306.676999225055, 4362.847300344489, 4378.32136018916, 4380.540043295456, 4389.648828093761, 4380.759058251795, 4381.38660587518, 4383.956160438387, 4393.802278897458, 4394.428724265841, 4280.608802139302, 4315.834724624349, 4336.609705126538, 4345.348197770344, 4350.58669426404, 4308.405889820755, 4334.50153232376, 4335.544767799367, 4336.371226172203, 4342.4789025317, 3958.762474251554, 3972.066564357374, 3982.14830104003, 3997.160596274786, 4014.136960553495, 5133.974330128362, 5245.186996015624, 5274.2879711238875, 5276.994741998016, 5340.385855626614, 4997.325361076245, 4998.425181104183, 4999.725015124167, 5014.924776128361, 5046.7476626168545, 5710.514606258473, 5713.800016999385, 5715.599908006441, 5753.1370294456165, 5759.625624334405, 4288.76411797351, 4319.33050377192, 4332.891677708051, 4378.117409513908, 4415.403920470728, 5616.943830561683, 5773.88452230953, 5826.0, 5846.766129354821, 5881.382454842223, 4374.868753937387, 4461.375407442961, 4461.620762235247, 4463.352813841975, 4477.238869392211, 4278.251306021434, 4525.456945166536, 4527.320901864747, 4532.297493888453, 4554.362389265505, 4848.95151048485, 4881.8535443936735, 4934.4572097069295, 4970.353853998957, 4998.375527953357, 5623.790884959753, 5643.858903527363, 5649.661020338793, 5681.687507187145, 5703.344115426779, 1467.4277031957545, 1514.4093803416677, 1526.8167170442773, 1528.778327142558, 1543.884208684353, 1067.7597540553468, 1085.87069447775, 1095.687728997232, 1100.2573263047411, 1116.8883111688765, 5344.9732751336, 5355.491228333302, 5359.785608575691, 5370.3287089113865, 5378.623496355218, 5604.523615492647, 5610.803621873297, 5625.353084395347, 5678.744456499468, 5689.77240910359, 5236.345456817898, 5396.2984811974975, 5421.749973760924, 5430.42980487051, 5546.805861794898, 2974.9256268593026, 2983.4928062229474, 2985.6118704568266, 2987.656419511784, 2997.190758495194, 5793.275840519935, 5804.390538993429, 5835.912461313083, 5847.766089356463, 5864.824055278348, 5497.972510137423, 5722.971385143048, 5724.341700704473, 5732.742026608813, 5763.6541807491685, 5832.7168023034865, 5838.321857230003, 5842.005085651792, 5844.311616656386, 5888.852778680567, 5351.411344752152, 5562.249096371938, 5587.804426845041, 5642.633228840113, 5685.943140568541, 5547.446714919829, 5572.91640625399, 5578.82844602638, 5578.86052848682, 5579.652208674763, 5752.597318187687, 5817.505512031525, 5870.383609721089, 5979.521638268841, 6009.128676341993, 4187.0, 4199.4330765346285, 4214.683898707548, 4230.70385073042, 4256.34026725858, 5747.971260143672, 5817.76728930838, 5831.7375718091935, 5836.970815145897, 5857.0043092673495, 5617.7191140442, 5618.876224755147, 5625.0, 5627.831165065055, 5636.661800291996, 5629.127485239795, 5635.9436405635415, 5637.746301416364, 5664.660120392789, 5677.9495793278375, 5407.621466497465, 5573.359063707726, 5622.297212848394, 5622.690752008679, 5628.8874222514505, 5604.915926261027, 5613.326400831927, 5623.381428042994, 5654.46282603152, 5660.518855897295, 5356.303680521663, 5514.207882438304, 5526.171074338881, 5564.805231817029, 5610.6154884174875], "value": 4395.125556268738, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [769.4572382373341, 787.6298139874257, 800.1558355934487, 867.4925168776266, 920.4385324951776, 15404.61488462789, 15929.362825486982, 16115.355385784569, 16332.18339083044, 16644.251008704607, 14799.0, 14999.85000149998, 15024.624384390396, 15214.239288035582, 15363.769543456858, 705.1608585782927, 825.7440193540007, 835.0063424524826, 835.6657337065162, 836.5566249887539, 730.82825535999, 794.3327604811957, 828.8218033122878, 831.7504748575434, 833.3166803221361, 861.0528418739399, 861.9698310559131, 862.762740246431, 862.8490014247513, 863.2403484933282, 717.3687155303352, 854.1159899504015, 856.6016802187013, 857.3355649371724, 857.7812657772259, 556.9275994120779, 604.4076804731388, 630.6941133550224, 634.311771727676, 636.0332294911708, 15843.603909902346, 15848.207589620588, 15899.44351947688, 15916.522504324888, 15942.0, 13256.204627722367, 13573.524926627619, 13774.793378099237, 13822.170669759847, 15084.321205545777, 13703.45186192551, 13799.793003104962, 14287.428502859977, 14343.85656143446, 14650.095487586652, 4707.5763181313505, 4742.407199100113, 4765.166095933232, 4908.0, 4949.678270912415, 84575.577122114, 84739.15260847374, 85585.14414855833, 87747.56126219392, 87967.56016219941, 12344.567940122053, 12549.996000320136, 12563.93718031404, 12576.119671622899, 12587.37063146839, 23649.172278970153, 23688.881555592456, 23825.166119185746, 24048.51902961931, 24450.14424495134, 8440.704575339834, 8512.404131710844, 8560.186782255676, 8564.357673174536, 8703.738887833375, 4597.770111494412, 4605.332226827091, 4670.95329046712, 4688.57802797743, 4707.929381059287, 3686.2627474505207, 3771.07608635886, 3789.033796381905, 3791.905202369963, 3793.0, 630.5649102119523, 635.4249404289126, 642.7075680565332, 643.8990564402344, 644.9419552240321, 753.3408267765705, 783.4633276205817, 791.8020494876281, 795.9363250939911, 801.531104303977, 10373.84439233412, 10502.947485262524, 10717.83923241152, 10949.233553651167, 10986.230963832615, 761.7143571160815, 786.130623225221, 794.3010151067024, 804.7786858613928, 806.6128258435983, 5099.5410413063, 5197.376314842243, 5203.14148165556, 5208.947910520847, 5237.214417837355, 85155.57422212973, 85219.5739021301, 87925.0, 89185.0, 89596.0, 57965.0, 60327.69836150879, 67414.66292668604, 71723.99999999895, 74115.62942185254, 52696.20955685591, 55109.520071596875, 63099.6845015772, 64846.35153648497, 65238.0, 11017.1186305097, 11647.417629118341, 11880.021371255647, 11890.28658280506, 12028.699282517657, 39557.40663890102, 39954.80022599868, 40776.59223407728, 41416.964575885846, 42101.36847947344, 41321.79339103285, 41626.0, 44958.77520612376, 49642.751786240835, 50118.74940625273, 13825.930870345584, 13857.930710346383, 14107.0, 14109.6472588182, 14219.360128794437, 14632.634184145481, 15394.07635541871, 15548.98387947948, 15753.921230393775, 15754.68490630158, 12756.744865102832, 14563.85436145625, 15436.996595221724, 15610.0, 16331.83668163303, 14857.702845943237, 15033.548993530212, 15230.619234519225, 15561.688766224386, 15786.842131578996, 14684.118952862862, 14998.2500874958, 15156.24218789034, 15212.771808423104, 15262.694746105239, 12080.879191207976, 12222.327771972627, 12978.351082445652, 13246.933765331112, 13484.32578371058, 12242.081843861924, 12263.82703455847, 12394.566190183301, 12598.811017834923, 12615.621531354074], "value": 7655.272846144471, "unit": "score"}], "name": "dromaeo_css", "value": 7582.976941802574, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 110.0, 109.0, 111.0, 111.0, 112.0, 111.0, 110.0, 111.0, 111.0], "value": 110.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 118.0, 119.0, 150.0, 118.0, 118.0, 120.0, 121.0, 137.0, 118.0], "value": 126.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 161.0, 159.0, 160.0, 159.0, 158.0, 161.0, 160.0, 159.0, 158.0], "value": 159.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 75.0, 107.0, 76.0, 77.0, 76.0, 76.0, 91.0, 76.0], "value": 80.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 83.0, 110.0, 83.0, 84.0, 83.0, 96.0, 83.0, 82.0, 112.0], "value": 89.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 117.0, 117.0, 116.0, 116.0, 116.0, 117.0, 117.0, 117.0, 116.0], "value": 116.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0], "value": 146.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 94.0], "value": 95.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [48.0, 50.0, 48.0, 48.0, 49.0, 48.0, 49.0, 48.0, 53.0, 49.0], "value": 49.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 62.0, 63.0, 63.0, 63.0, 63.0, 63.0, 63.0, 63.0, 63.0], "value": 62.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 75.0, 84.0, 80.0, 81.0, 90.0, 76.0, 76.0, 76.0], "value": 78.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [131.0, 139.0, 123.0, 123.0, 126.0, 134.0, 117.0, 124.0, 152.0, 128.0], "value": 129.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 160.0, 157.0, 159.0, 158.0, 160.0, 157.0, 156.0, 153.0, 156.0], "value": 157.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 61.0, 61.0, 63.0, 61.0, 62.0, 62.0, 62.0, 60.0, 59.0], "value": 61.3, "unit": "score"}], "name": "kraken", "value": 1463.2, "alertThreshold": 2.0}]} 08:35:34 INFO - Return code: 0 08:35:34 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 08:35:34 ERROR - # TBPL SUCCESS # 08:35:34 INFO - Running post-action listener: _resource_record_post_action 08:35:34 INFO - [mozharness: 2017-02-26 16:35:34.907885Z] Finished run-tests step (success) 08:35:34 INFO - Running post-run listener: _resource_record_post_run 08:35:34 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 266240; Write bytes: 364929024; Read time: 40; Write time: 311628 08:35:34 INFO - TinderboxPrint: CPU usage
13.0% 08:35:34 INFO - TinderboxPrint: I/O read bytes / time
266,240 / 40 08:35:34 INFO - TinderboxPrint: I/O write bytes / time
364,929,024 / 311,628 08:35:34 INFO - TinderboxPrint: CPU idle
8,280.1 (87.0%) 08:35:34 INFO - TinderboxPrint: CPU user
1,194.1 (12.5%) 08:35:34 INFO - TinderboxPrint: Swap in / out
0 / 0 08:35:34 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 110587904; Read time: 0; Write time: 131072 08:35:35 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 262144; Write bytes: 254341120; Read time: 28; Write time: 180556 08:35:35 INFO - Running post-run listener: _upload_blobber_files 08:35:35 INFO - Blob upload gear active. 08:35:35 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:35:35 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 08:35:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 08:35:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 08:35:35 INFO - (blobuploader) - INFO - Open directory for files ... 08:35:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 08:35:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:35:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:35:39 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 08:35:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:35:39 INFO - (blobuploader) - INFO - Done attempting. 08:35:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 08:35:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:35:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:35:40 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 08:35:40 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:35:40 INFO - (blobuploader) - INFO - Done attempting. 08:35:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 08:35:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:35:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:35:40 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 08:35:40 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:35:40 INFO - (blobuploader) - INFO - Done attempting. 08:35:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 08:35:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:35:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:35:41 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 08:35:41 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:35:41 INFO - (blobuploader) - INFO - Done attempting. 08:35:41 INFO - (blobuploader) - INFO - Iteration through files over. 08:35:41 INFO - Return code: 0 08:35:41 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:35:41 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:35:41 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c321737aeb5e89ef6cd83a958715f4ed11f9e27e45f6c6beb4d446644aa089b8d8accf130dd60c7052df8c0b16d6b65aa829ea158a7a47e9d1e09d408a54096d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/05c9873abd9302a5fb43d08f918ab09d8fa1dae1608a8177c41d471e382bfd28725d65f7b10a75756a8ef86210d54a9d3a2f806f697bd51fbdde825aa0c8be8e", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/4cc1433033248f433cfe5a429d8ea40c76bf80bb8206fd55a512ce7c44fb1f645782a8404a459cc54d43a9602df571ee14b3d6d840f574e875803b48547e3c73", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/48c41617510fb4e4852d9e3143ff081e9423e281eff6d7020b424b099b8c4d087c88dcdbf74b74df2933710db1e096af0e1a90d8b25f0e8582ba57276c850689"} 08:35:41 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:35:41 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:35:41 INFO - Contents: 08:35:41 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c321737aeb5e89ef6cd83a958715f4ed11f9e27e45f6c6beb4d446644aa089b8d8accf130dd60c7052df8c0b16d6b65aa829ea158a7a47e9d1e09d408a54096d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/05c9873abd9302a5fb43d08f918ab09d8fa1dae1608a8177c41d471e382bfd28725d65f7b10a75756a8ef86210d54a9d3a2f806f697bd51fbdde825aa0c8be8e", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/4cc1433033248f433cfe5a429d8ea40c76bf80bb8206fd55a512ce7c44fb1f645782a8404a459cc54d43a9602df571ee14b3d6d840f574e875803b48547e3c73", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/48c41617510fb4e4852d9e3143ff081e9423e281eff6d7020b424b099b8c4d087c88dcdbf74b74df2933710db1e096af0e1a90d8b25f0e8582ba57276c850689"} 08:35:41 INFO - Running post-run listener: copy_logs_to_upload_dir 08:35:41 INFO - Copying logs to upload dir... 08:35:41 INFO - mkdir: /builds/slave/test/build/upload/logs 08:35:41 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1238.039188 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2017-02-26 08:35:41.727217) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-26 08:35:41.731658) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c321737aeb5e89ef6cd83a958715f4ed11f9e27e45f6c6beb4d446644aa089b8d8accf130dd60c7052df8c0b16d6b65aa829ea158a7a47e9d1e09d408a54096d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/05c9873abd9302a5fb43d08f918ab09d8fa1dae1608a8177c41d471e382bfd28725d65f7b10a75756a8ef86210d54a9d3a2f806f697bd51fbdde825aa0c8be8e", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/4cc1433033248f433cfe5a429d8ea40c76bf80bb8206fd55a512ce7c44fb1f645782a8404a459cc54d43a9602df571ee14b3d6d840f574e875803b48547e3c73", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/48c41617510fb4e4852d9e3143ff081e9423e281eff6d7020b424b099b8c4d087c88dcdbf74b74df2933710db1e096af0e1a90d8b25f0e8582ba57276c850689"} build_url:https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011228 build_url: 'https://queue.taskcluster.net/v1/task/EjcYdpQETZ68Oa26pv8O7Q/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c321737aeb5e89ef6cd83a958715f4ed11f9e27e45f6c6beb4d446644aa089b8d8accf130dd60c7052df8c0b16d6b65aa829ea158a7a47e9d1e09d408a54096d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/05c9873abd9302a5fb43d08f918ab09d8fa1dae1608a8177c41d471e382bfd28725d65f7b10a75756a8ef86210d54a9d3a2f806f697bd51fbdde825aa0c8be8e", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/4cc1433033248f433cfe5a429d8ea40c76bf80bb8206fd55a512ce7c44fb1f645782a8404a459cc54d43a9602df571ee14b3d6d840f574e875803b48547e3c73", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/48c41617510fb4e4852d9e3143ff081e9423e281eff6d7020b424b099b8c4d087c88dcdbf74b74df2933710db1e096af0e1a90d8b25f0e8582ba57276c850689"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-26 08:35:41.757186) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-26 08:35:41.757577) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=41a7e32711b8e08598a63237000001d6-1488125702.106165-641393717 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004508 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-26 08:35:41.843122) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-26 08:35:41.843488) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-26 08:35:41.843843) ========= ========= Total master_lag: 0.19 =========